[2024-11-16T15:26:20.628Z] Running test renaissance-dec-tree_0 ... [2024-11-16T15:26:20.941Z] =============================================== [2024-11-16T15:26:20.941Z] renaissance-dec-tree_0 Start Time: Sat Nov 16 15:26:20 2024 Epoch Time (ms): 1731770780785 [2024-11-16T15:26:20.941Z] variation: NoOptions [2024-11-16T15:26:21.269Z] JVM_OPTIONS: [2024-11-16T15:26:21.270Z] { \ [2024-11-16T15:26:21.270Z] echo ""; echo "TEST SETUP:"; \ [2024-11-16T15:26:21.270Z] echo "Nothing to be done for setup."; \ [2024-11-16T15:26:21.270Z] mkdir -p "C:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17317695955338\\renaissance-dec-tree_0"; \ [2024-11-16T15:26:21.270Z] cd "C:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17317695955338\\renaissance-dec-tree_0"; \ [2024-11-16T15:26:21.270Z] echo ""; echo "TESTING:"; \ [2024-11-16T15:26:21.270Z] "c:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/jdkbinary/j2sdk-image\\bin\\java" -jar "C:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests///..//jvmtest\\perf\\renaissance\\renaissance.jar" --json ""C:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17317695955338\\renaissance-dec-tree_0"\\dec-tree.json" dec-tree; \ [2024-11-16T15:26:21.270Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-dec-tree_0""_PASSED"; echo "-----------------------------------"; cd C:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/; rm -f -r "C:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17317695955338\\renaissance-dec-tree_0"; else echo "-----------------------------------"; echo "renaissance-dec-tree_0""_FAILED"; echo "-----------------------------------"; fi; \ [2024-11-16T15:26:21.270Z] echo ""; echo "TEST TEARDOWN:"; \ [2024-11-16T15:26:21.270Z] echo "Nothing to be done for teardown."; \ [2024-11-16T15:26:21.270Z] } 2>&1 | tee -a "C:/workspace/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17317695955338\\TestTargetResult"; [2024-11-16T15:26:21.270Z] [2024-11-16T15:26:21.270Z] TEST SETUP: [2024-11-16T15:26:21.270Z] Nothing to be done for setup. [2024-11-16T15:26:21.270Z] [2024-11-16T15:26:21.270Z] TESTING: [2024-11-16T15:26:36.896Z] Using Spark's default log4j profile: org/apache/spark/log4j-defaults.properties [2024-11-16T15:26:38.551Z] NOTE: 'dec-tree' benchmark uses Spark local executor with 4 (out of 4) threads. [2024-11-16T15:26:43.173Z] ====== dec-tree (apache-spark) [default], iteration 0 started ====== [2024-11-16T15:26:43.499Z] GC before operation: completed in 204.654 ms, heap usage 70.893 MB -> 24.939 MB. [2024-11-16T15:26:54.574Z] ====== dec-tree (apache-spark) [default], iteration 0 completed (10229.545 ms) ====== [2024-11-16T15:26:54.574Z] ====== dec-tree (apache-spark) [default], iteration 1 started ====== [2024-11-16T15:26:54.574Z] GC before operation: completed in 373.290 ms, heap usage 313.831 MB -> 76.898 MB. [2024-11-16T15:26:57.108Z] ====== dec-tree (apache-spark) [default], iteration 1 completed (2724.215 ms) ====== [2024-11-16T15:26:57.108Z] ====== dec-tree (apache-spark) [default], iteration 2 started ====== [2024-11-16T15:26:57.108Z] GC before operation: completed in 312.657 ms, heap usage 747.698 MB -> 82.156 MB. [2024-11-16T15:26:59.457Z] ====== dec-tree (apache-spark) [default], iteration 2 completed (2504.984 ms) ====== [2024-11-16T15:26:59.457Z] ====== dec-tree (apache-spark) [default], iteration 3 started ====== [2024-11-16T15:26:59.816Z] GC before operation: completed in 237.921 ms, heap usage 563.515 MB -> 66.128 MB. [2024-11-16T15:27:02.007Z] ====== dec-tree (apache-spark) [default], iteration 3 completed (2251.227 ms) ====== [2024-11-16T15:27:02.007Z] ====== dec-tree (apache-spark) [default], iteration 4 started ====== [2024-11-16T15:27:02.336Z] GC before operation: completed in 282.602 ms, heap usage 335.596 MB -> 66.139 MB. [2024-11-16T15:27:02.336Z] 24/11/16 15:27:02 WARN BlockManager: Asked to remove block broadcast_50, which does not exist [2024-11-16T15:27:04.594Z] ====== dec-tree (apache-spark) [default], iteration 4 completed (2155.557 ms) ====== [2024-11-16T15:27:04.594Z] ====== dec-tree (apache-spark) [default], iteration 5 started ====== [2024-11-16T15:27:04.594Z] GC before operation: completed in 221.852 ms, heap usage 263.177 MB -> 65.982 MB. [2024-11-16T15:27:06.982Z] ====== dec-tree (apache-spark) [default], iteration 5 completed (2143.851 ms) ====== [2024-11-16T15:27:06.982Z] ====== dec-tree (apache-spark) [default], iteration 6 started ====== [2024-11-16T15:27:06.982Z] GC before operation: completed in 241.113 ms, heap usage 303.500 MB -> 55.560 MB. [2024-11-16T15:27:09.183Z] ====== dec-tree (apache-spark) [default], iteration 6 completed (1872.315 ms) ====== [2024-11-16T15:27:09.183Z] ====== dec-tree (apache-spark) [default], iteration 7 started ====== [2024-11-16T15:27:09.183Z] GC before operation: completed in 242.043 ms, heap usage 236.821 MB -> 66.624 MB. [2024-11-16T15:27:11.364Z] ====== dec-tree (apache-spark) [default], iteration 7 completed (1883.146 ms) ====== [2024-11-16T15:27:11.364Z] ====== dec-tree (apache-spark) [default], iteration 8 started ====== [2024-11-16T15:27:11.364Z] GC before operation: completed in 271.441 ms, heap usage 241.787 MB -> 66.813 MB. [2024-11-16T15:27:13.553Z] ====== dec-tree (apache-spark) [default], iteration 8 completed (1984.982 ms) ====== [2024-11-16T15:27:13.553Z] ====== dec-tree (apache-spark) [default], iteration 9 started ====== [2024-11-16T15:27:13.553Z] GC before operation: completed in 276.409 ms, heap usage 247.935 MB -> 66.978 MB. [2024-11-16T15:27:15.733Z] ====== dec-tree (apache-spark) [default], iteration 9 completed (1841.748 ms) ====== [2024-11-16T15:27:15.733Z] ====== dec-tree (apache-spark) [default], iteration 10 started ====== [2024-11-16T15:27:15.733Z] GC before operation: completed in 258.747 ms, heap usage 237.290 MB -> 66.911 MB. [2024-11-16T15:27:17.453Z] ====== dec-tree (apache-spark) [default], iteration 10 completed (1778.565 ms) ====== [2024-11-16T15:27:17.453Z] ====== dec-tree (apache-spark) [default], iteration 11 started ====== [2024-11-16T15:27:17.781Z] GC before operation: completed in 269.662 ms, heap usage 223.094 MB -> 67.061 MB. [2024-11-16T15:27:19.401Z] ====== dec-tree (apache-spark) [default], iteration 11 completed (1710.393 ms) ====== [2024-11-16T15:27:19.401Z] ====== dec-tree (apache-spark) [default], iteration 12 started ====== [2024-11-16T15:27:19.730Z] GC before operation: completed in 234.614 ms, heap usage 242.285 MB -> 67.225 MB. [2024-11-16T15:27:21.916Z] ====== dec-tree (apache-spark) [default], iteration 12 completed (1871.841 ms) ====== [2024-11-16T15:27:21.916Z] ====== dec-tree (apache-spark) [default], iteration 13 started ====== [2024-11-16T15:27:21.916Z] GC before operation: completed in 253.453 ms, heap usage 234.920 MB -> 72.978 MB. [2024-11-16T15:27:23.517Z] ====== dec-tree (apache-spark) [default], iteration 13 completed (1727.465 ms) ====== [2024-11-16T15:27:23.517Z] ====== dec-tree (apache-spark) [default], iteration 14 started ====== [2024-11-16T15:27:23.845Z] GC before operation: completed in 240.528 ms, heap usage 232.792 MB -> 67.853 MB. [2024-11-16T15:27:26.030Z] ====== dec-tree (apache-spark) [default], iteration 14 completed (1874.439 ms) ====== [2024-11-16T15:27:26.030Z] ====== dec-tree (apache-spark) [default], iteration 15 started ====== [2024-11-16T15:27:26.030Z] GC before operation: completed in 253.122 ms, heap usage 221.479 MB -> 73.297 MB. [2024-11-16T15:27:27.637Z] ====== dec-tree (apache-spark) [default], iteration 15 completed (1747.597 ms) ====== [2024-11-16T15:27:27.637Z] ====== dec-tree (apache-spark) [default], iteration 16 started ====== [2024-11-16T15:27:27.967Z] GC before operation: completed in 261.067 ms, heap usage 238.091 MB -> 57.101 MB. [2024-11-16T15:27:29.652Z] ====== dec-tree (apache-spark) [default], iteration 16 completed (1728.933 ms) ====== [2024-11-16T15:27:29.652Z] ====== dec-tree (apache-spark) [default], iteration 17 started ====== [2024-11-16T15:27:29.977Z] GC before operation: completed in 233.817 ms, heap usage 217.440 MB -> 57.188 MB. [2024-11-16T15:27:31.584Z] ====== dec-tree (apache-spark) [default], iteration 17 completed (1759.002 ms) ====== [2024-11-16T15:27:31.584Z] ====== dec-tree (apache-spark) [default], iteration 18 started ====== [2024-11-16T15:27:31.916Z] GC before operation: completed in 265.409 ms, heap usage 217.708 MB -> 73.789 MB. [2024-11-16T15:27:33.518Z] ====== dec-tree (apache-spark) [default], iteration 18 completed (1628.642 ms) ====== [2024-11-16T15:27:33.518Z] ====== dec-tree (apache-spark) [default], iteration 19 started ====== [2024-11-16T15:27:33.847Z] GC before operation: completed in 241.241 ms, heap usage 240.336 MB -> 73.891 MB. [2024-11-16T15:27:35.483Z] ====== dec-tree (apache-spark) [default], iteration 19 completed (1799.264 ms) ====== [2024-11-16T15:27:35.483Z] ====== dec-tree (apache-spark) [default], iteration 20 started ====== [2024-11-16T15:27:35.806Z] GC before operation: completed in 239.339 ms, heap usage 238.509 MB -> 74.060 MB. [2024-11-16T15:27:35.806Z] 24/11/16 15:27:35 WARN BlockManager: Asked to remove block broadcast_274, which does not exist [2024-11-16T15:27:37.441Z] ====== dec-tree (apache-spark) [default], iteration 20 completed (1711.199 ms) ====== [2024-11-16T15:27:37.441Z] ====== dec-tree (apache-spark) [default], iteration 21 started ====== [2024-11-16T15:27:37.768Z] GC before operation: completed in 261.996 ms, heap usage 262.736 MB -> 68.550 MB. [2024-11-16T15:27:39.938Z] ====== dec-tree (apache-spark) [default], iteration 21 completed (1758.052 ms) ====== [2024-11-16T15:27:39.938Z] ====== dec-tree (apache-spark) [default], iteration 22 started ====== [2024-11-16T15:27:39.938Z] GC before operation: completed in 223.516 ms, heap usage 216.867 MB -> 74.526 MB. [2024-11-16T15:27:41.532Z] ====== dec-tree (apache-spark) [default], iteration 22 completed (1775.866 ms) ====== [2024-11-16T15:27:41.532Z] ====== dec-tree (apache-spark) [default], iteration 23 started ====== [2024-11-16T15:27:41.913Z] GC before operation: completed in 255.802 ms, heap usage 224.805 MB -> 79.878 MB. [2024-11-16T15:27:43.614Z] ====== dec-tree (apache-spark) [default], iteration 23 completed (1784.992 ms) ====== [2024-11-16T15:27:43.614Z] ====== dec-tree (apache-spark) [default], iteration 24 started ====== [2024-11-16T15:27:43.938Z] GC before operation: completed in 242.537 ms, heap usage 230.280 MB -> 74.565 MB. [2024-11-16T15:27:45.540Z] ====== dec-tree (apache-spark) [default], iteration 24 completed (1634.644 ms) ====== [2024-11-16T15:27:45.540Z] ====== dec-tree (apache-spark) [default], iteration 25 started ====== [2024-11-16T15:27:45.868Z] GC before operation: completed in 248.137 ms, heap usage 234.925 MB -> 69.084 MB. [2024-11-16T15:27:47.501Z] ====== dec-tree (apache-spark) [default], iteration 25 completed (1746.125 ms) ====== [2024-11-16T15:27:47.501Z] ====== dec-tree (apache-spark) [default], iteration 26 started ====== [2024-11-16T15:27:47.830Z] GC before operation: completed in 231.181 ms, heap usage 223.940 MB -> 75.943 MB. [2024-11-16T15:27:49.418Z] ====== dec-tree (apache-spark) [default], iteration 26 completed (1661.849 ms) ====== [2024-11-16T15:27:49.418Z] ====== dec-tree (apache-spark) [default], iteration 27 started ====== [2024-11-16T15:27:49.755Z] GC before operation: completed in 245.870 ms, heap usage 226.562 MB -> 69.566 MB. [2024-11-16T15:27:51.442Z] ====== dec-tree (apache-spark) [default], iteration 27 completed (1778.525 ms) ====== [2024-11-16T15:27:51.442Z] ====== dec-tree (apache-spark) [default], iteration 28 started ====== [2024-11-16T15:27:51.770Z] GC before operation: completed in 220.928 ms, heap usage 222.157 MB -> 75.113 MB. [2024-11-16T15:27:53.387Z] ====== dec-tree (apache-spark) [default], iteration 28 completed (1756.414 ms) ====== [2024-11-16T15:27:53.387Z] ====== dec-tree (apache-spark) [default], iteration 29 started ====== [2024-11-16T15:27:53.715Z] GC before operation: completed in 225.010 ms, heap usage 224.954 MB -> 69.629 MB. [2024-11-16T15:27:55.332Z] ====== dec-tree (apache-spark) [default], iteration 29 completed (1647.935 ms) ====== [2024-11-16T15:27:55.333Z] ====== dec-tree (apache-spark) [default], iteration 30 started ====== [2024-11-16T15:27:55.646Z] GC before operation: completed in 244.599 ms, heap usage 229.175 MB -> 75.376 MB. [2024-11-16T15:27:57.261Z] ====== dec-tree (apache-spark) [default], iteration 30 completed (1718.342 ms) ====== [2024-11-16T15:27:57.261Z] ====== dec-tree (apache-spark) [default], iteration 31 started ====== [2024-11-16T15:27:57.590Z] GC before operation: completed in 235.276 ms, heap usage 226.417 MB -> 80.955 MB. [2024-11-16T15:27:59.192Z] ====== dec-tree (apache-spark) [default], iteration 31 completed (1665.579 ms) ====== [2024-11-16T15:27:59.192Z] ====== dec-tree (apache-spark) [default], iteration 32 started ====== [2024-11-16T15:27:59.514Z] GC before operation: completed in 233.382 ms, heap usage 232.476 MB -> 70.175 MB. [2024-11-16T15:28:01.119Z] ====== dec-tree (apache-spark) [default], iteration 32 completed (1709.663 ms) ====== [2024-11-16T15:28:01.119Z] ====== dec-tree (apache-spark) [default], iteration 33 started ====== [2024-11-16T15:28:01.444Z] GC before operation: completed in 244.013 ms, heap usage 223.400 MB -> 75.769 MB. [2024-11-16T15:28:03.049Z] ====== dec-tree (apache-spark) [default], iteration 33 completed (1752.828 ms) ====== [2024-11-16T15:28:03.050Z] ====== dec-tree (apache-spark) [default], iteration 34 started ====== [2024-11-16T15:28:03.376Z] GC before operation: completed in 273.120 ms, heap usage 236.868 MB -> 59.381 MB. [2024-11-16T15:28:04.965Z] ====== dec-tree (apache-spark) [default], iteration 34 completed (1688.370 ms) ====== [2024-11-16T15:28:04.965Z] ====== dec-tree (apache-spark) [default], iteration 35 started ====== [2024-11-16T15:28:05.293Z] GC before operation: completed in 271.722 ms, heap usage 214.428 MB -> 81.690 MB. [2024-11-16T15:28:06.958Z] ====== dec-tree (apache-spark) [default], iteration 35 completed (1745.851 ms) ====== [2024-11-16T15:28:06.958Z] ====== dec-tree (apache-spark) [default], iteration 36 started ====== [2024-11-16T15:28:07.282Z] GC before operation: completed in 242.675 ms, heap usage 238.194 MB -> 76.183 MB. [2024-11-16T15:28:08.965Z] ====== dec-tree (apache-spark) [default], iteration 36 completed (1717.899 ms) ====== [2024-11-16T15:28:08.965Z] ====== dec-tree (apache-spark) [default], iteration 37 started ====== [2024-11-16T15:28:09.294Z] GC before operation: completed in 231.734 ms, heap usage 227.171 MB -> 76.385 MB. [2024-11-16T15:28:10.892Z] ====== dec-tree (apache-spark) [default], iteration 37 completed (1671.459 ms) ====== [2024-11-16T15:28:10.892Z] ====== dec-tree (apache-spark) [default], iteration 38 started ====== [2024-11-16T15:28:11.240Z] GC before operation: completed in 236.282 ms, heap usage 223.325 MB -> 76.422 MB. [2024-11-16T15:28:11.240Z] 24/11/16 15:28:10 WARN BlockManager: Asked to remove block rdd_1859_0, which does not exist [2024-11-16T15:28:11.240Z] 24/11/16 15:28:10 WARN BlockManager: Asked to remove block rdd_1859_2, which does not exist [2024-11-16T15:28:12.843Z] ====== dec-tree (apache-spark) [default], iteration 38 completed (1708.999 ms) ====== [2024-11-16T15:28:12.843Z] ====== dec-tree (apache-spark) [default], iteration 39 started ====== [2024-11-16T15:28:13.169Z] GC before operation: completed in 228.932 ms, heap usage 224.720 MB -> 76.571 MB. [2024-11-16T15:28:14.768Z] ====== dec-tree (apache-spark) [default], iteration 39 completed (1641.720 ms) ====== [2024-11-16T15:28:15.444Z] ----------------------------------- [2024-11-16T15:28:15.444Z] renaissance-dec-tree_0_PASSED [2024-11-16T15:28:15.444Z] ----------------------------------- [2024-11-16T15:28:15.444Z] [2024-11-16T15:28:15.444Z] TEST TEARDOWN: [2024-11-16T15:28:15.444Z] Nothing to be done for teardown. [2024-11-16T15:28:15.444Z] renaissance-dec-tree_0 Finish Time: Sat Nov 16 15:28:15 2024 Epoch Time (ms): 1731770895389