[2025-02-07T07:58:48.869Z] Running test renaissance-dec-tree_0 ... [2025-02-07T07:58:48.869Z] =============================================== [2025-02-07T07:58:48.869Z] renaissance-dec-tree_0 Start Time: Fri Feb 7 07:58:48 2025 Epoch Time (ms): 1738915128788 [2025-02-07T07:58:49.196Z] variation: NoOptions [2025-02-07T07:58:49.196Z] JVM_OPTIONS: [2025-02-07T07:58:49.196Z] { \ [2025-02-07T07:58:49.196Z] echo ""; echo "TEST SETUP:"; \ [2025-02-07T07:58:49.196Z] echo "Nothing to be done for setup."; \ [2025-02-07T07:58:49.196Z] mkdir -p "C:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17389141106519\\renaissance-dec-tree_0"; \ [2025-02-07T07:58:49.196Z] cd "C:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17389141106519\\renaissance-dec-tree_0"; \ [2025-02-07T07:58:49.196Z] echo ""; echo "TESTING:"; \ [2025-02-07T07:58:49.196Z] "c:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/jdkbinary/j2sdk-image\\bin\\java" -jar "C:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests///..//jvmtest\\perf\\renaissance\\renaissance.jar" --json ""C:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17389141106519\\renaissance-dec-tree_0"\\dec-tree.json" dec-tree; \ [2025-02-07T07:58:49.196Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-dec-tree_0""_PASSED"; echo "-----------------------------------"; cd C:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/; rm -f -r "C:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17389141106519\\renaissance-dec-tree_0"; else echo "-----------------------------------"; echo "renaissance-dec-tree_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-02-07T07:58:49.196Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-02-07T07:58:49.196Z] echo "Nothing to be done for teardown."; \ [2025-02-07T07:58:49.196Z] } 2>&1 | tee -a "C:/jenkins/workspace/Test_openjdk8_hs_extended.perf_x86-64_windows/aqa-tests/\\TKG\\output_17389141106519\\TestTargetResult"; [2025-02-07T07:58:49.196Z] [2025-02-07T07:58:49.196Z] TEST SETUP: [2025-02-07T07:58:49.196Z] Nothing to be done for setup. [2025-02-07T07:58:49.524Z] [2025-02-07T07:58:49.524Z] TESTING: [2025-02-07T07:59:05.167Z] Using Spark's default log4j profile: org/apache/spark/log4j-defaults.properties [2025-02-07T07:59:05.167Z] NOTE: 'dec-tree' benchmark uses Spark local executor with 4 (out of 4) threads. [2025-02-07T07:59:08.841Z] ====== dec-tree (apache-spark) [default], iteration 0 started ====== [2025-02-07T07:59:08.841Z] GC before operation: completed in 174.366 ms, heap usage 119.789 MB -> 28.249 MB. [2025-02-07T07:59:19.862Z] ====== dec-tree (apache-spark) [default], iteration 0 completed (9220.236 ms) ====== [2025-02-07T07:59:19.862Z] ====== dec-tree (apache-spark) [default], iteration 1 started ====== [2025-02-07T07:59:19.862Z] GC before operation: completed in 396.033 ms, heap usage 299.343 MB -> 55.297 MB. [2025-02-07T07:59:21.011Z] ====== dec-tree (apache-spark) [default], iteration 1 completed (2400.390 ms) ====== [2025-02-07T07:59:21.011Z] ====== dec-tree (apache-spark) [default], iteration 2 started ====== [2025-02-07T07:59:21.403Z] GC before operation: completed in 245.154 ms, heap usage 251.229 MB -> 65.730 MB. [2025-02-07T07:59:23.222Z] ====== dec-tree (apache-spark) [default], iteration 2 completed (1920.190 ms) ====== [2025-02-07T07:59:23.222Z] ====== dec-tree (apache-spark) [default], iteration 3 started ====== [2025-02-07T07:59:23.222Z] GC before operation: completed in 218.991 ms, heap usage 245.249 MB -> 54.732 MB. [2025-02-07T07:59:24.897Z] ====== dec-tree (apache-spark) [default], iteration 3 completed (1736.954 ms) ====== [2025-02-07T07:59:24.897Z] ====== dec-tree (apache-spark) [default], iteration 4 started ====== [2025-02-07T07:59:25.234Z] GC before operation: completed in 248.314 ms, heap usage 237.022 MB -> 54.864 MB. [2025-02-07T07:59:26.850Z] ====== dec-tree (apache-spark) [default], iteration 4 completed (1583.228 ms) ====== [2025-02-07T07:59:26.850Z] ====== dec-tree (apache-spark) [default], iteration 5 started ====== [2025-02-07T07:59:27.179Z] GC before operation: completed in 171.112 ms, heap usage 258.732 MB -> 71.673 MB. [2025-02-07T07:59:28.951Z] ====== dec-tree (apache-spark) [default], iteration 5 completed (1536.483 ms) ====== [2025-02-07T07:59:28.951Z] ====== dec-tree (apache-spark) [default], iteration 6 started ====== [2025-02-07T07:59:28.951Z] GC before operation: completed in 222.294 ms, heap usage 290.378 MB -> 55.346 MB. [2025-02-07T07:59:30.571Z] ====== dec-tree (apache-spark) [default], iteration 6 completed (1509.783 ms) ====== [2025-02-07T07:59:30.571Z] ====== dec-tree (apache-spark) [default], iteration 7 started ====== [2025-02-07T07:59:30.571Z] GC before operation: completed in 187.807 ms, heap usage 250.600 MB -> 77.754 MB. [2025-02-07T07:59:32.213Z] ====== dec-tree (apache-spark) [default], iteration 7 completed (1453.971 ms) ====== [2025-02-07T07:59:32.213Z] ====== dec-tree (apache-spark) [default], iteration 8 started ====== [2025-02-07T07:59:32.213Z] GC before operation: completed in 246.237 ms, heap usage 279.503 MB -> 72.459 MB. [2025-02-07T07:59:33.887Z] ====== dec-tree (apache-spark) [default], iteration 8 completed (1482.122 ms) ====== [2025-02-07T07:59:33.887Z] ====== dec-tree (apache-spark) [default], iteration 9 started ====== [2025-02-07T07:59:33.887Z] GC before operation: completed in 223.563 ms, heap usage 279.858 MB -> 66.778 MB. [2025-02-07T07:59:35.495Z] ====== dec-tree (apache-spark) [default], iteration 9 completed (1478.252 ms) ====== [2025-02-07T07:59:35.495Z] ====== dec-tree (apache-spark) [default], iteration 10 started ====== [2025-02-07T07:59:35.495Z] GC before operation: completed in 238.176 ms, heap usage 268.861 MB -> 72.560 MB. [2025-02-07T07:59:37.121Z] ====== dec-tree (apache-spark) [default], iteration 10 completed (1373.817 ms) ====== [2025-02-07T07:59:37.121Z] ====== dec-tree (apache-spark) [default], iteration 11 started ====== [2025-02-07T07:59:37.446Z] GC before operation: completed in 297.975 ms, heap usage 265.872 MB -> 72.853 MB. [2025-02-07T07:59:38.627Z] ====== dec-tree (apache-spark) [default], iteration 11 completed (1428.243 ms) ====== [2025-02-07T07:59:38.627Z] ====== dec-tree (apache-spark) [default], iteration 12 started ====== [2025-02-07T07:59:38.952Z] GC before operation: completed in 221.317 ms, heap usage 267.632 MB -> 72.848 MB. [2025-02-07T07:59:40.557Z] ====== dec-tree (apache-spark) [default], iteration 12 completed (1332.606 ms) ====== [2025-02-07T07:59:40.557Z] ====== dec-tree (apache-spark) [default], iteration 13 started ====== [2025-02-07T07:59:40.557Z] GC before operation: completed in 241.844 ms, heap usage 263.580 MB -> 73.179 MB. [2025-02-07T07:59:41.715Z] ====== dec-tree (apache-spark) [default], iteration 13 completed (1295.507 ms) ====== [2025-02-07T07:59:41.715Z] ====== dec-tree (apache-spark) [default], iteration 14 started ====== [2025-02-07T07:59:42.044Z] GC before operation: completed in 228.422 ms, heap usage 270.720 MB -> 78.584 MB. [2025-02-07T07:59:43.649Z] ====== dec-tree (apache-spark) [default], iteration 14 completed (1404.031 ms) ====== [2025-02-07T07:59:43.649Z] ====== dec-tree (apache-spark) [default], iteration 15 started ====== [2025-02-07T07:59:43.649Z] GC before operation: completed in 232.925 ms, heap usage 275.923 MB -> 73.312 MB. [2025-02-07T07:59:45.264Z] ====== dec-tree (apache-spark) [default], iteration 15 completed (1482.523 ms) ====== [2025-02-07T07:59:45.264Z] ====== dec-tree (apache-spark) [default], iteration 16 started ====== [2025-02-07T07:59:45.264Z] GC before operation: completed in 226.055 ms, heap usage 273.361 MB -> 57.110 MB. [2025-02-07T07:59:46.874Z] ====== dec-tree (apache-spark) [default], iteration 16 completed (1368.805 ms) ====== [2025-02-07T07:59:46.874Z] ====== dec-tree (apache-spark) [default], iteration 17 started ====== [2025-02-07T07:59:46.874Z] GC before operation: completed in 215.029 ms, heap usage 252.698 MB -> 57.150 MB. [2025-02-07T07:59:48.478Z] ====== dec-tree (apache-spark) [default], iteration 17 completed (1377.854 ms) ====== [2025-02-07T07:59:48.478Z] ====== dec-tree (apache-spark) [default], iteration 18 started ====== [2025-02-07T07:59:48.478Z] GC before operation: completed in 205.453 ms, heap usage 249.373 MB -> 73.772 MB. [2025-02-07T07:59:50.085Z] ====== dec-tree (apache-spark) [default], iteration 18 completed (1381.737 ms) ====== [2025-02-07T07:59:50.085Z] ====== dec-tree (apache-spark) [default], iteration 19 started ====== [2025-02-07T07:59:50.085Z] GC before operation: completed in 207.662 ms, heap usage 272.237 MB -> 73.874 MB. [2025-02-07T07:59:51.719Z] ====== dec-tree (apache-spark) [default], iteration 19 completed (1499.392 ms) ====== [2025-02-07T07:59:51.719Z] ====== dec-tree (apache-spark) [default], iteration 20 started ====== [2025-02-07T07:59:52.044Z] GC before operation: completed in 244.728 ms, heap usage 268.497 MB -> 74.101 MB. [2025-02-07T07:59:53.173Z] ====== dec-tree (apache-spark) [default], iteration 20 completed (1302.515 ms) ====== [2025-02-07T07:59:53.173Z] ====== dec-tree (apache-spark) [default], iteration 21 started ====== [2025-02-07T07:59:53.500Z] GC before operation: completed in 233.970 ms, heap usage 267.771 MB -> 74.185 MB. [2025-02-07T07:59:54.645Z] ====== dec-tree (apache-spark) [default], iteration 21 completed (1324.179 ms) ====== [2025-02-07T07:59:54.645Z] ====== dec-tree (apache-spark) [default], iteration 22 started ====== [2025-02-07T07:59:54.982Z] GC before operation: completed in 197.488 ms, heap usage 267.656 MB -> 85.366 MB. [2025-02-07T07:59:56.591Z] ====== dec-tree (apache-spark) [default], iteration 22 completed (1378.823 ms) ====== [2025-02-07T07:59:56.591Z] ====== dec-tree (apache-spark) [default], iteration 23 started ====== [2025-02-07T07:59:56.591Z] GC before operation: completed in 216.671 ms, heap usage 291.596 MB -> 68.783 MB. [2025-02-07T07:59:57.752Z] ====== dec-tree (apache-spark) [default], iteration 23 completed (1295.265 ms) ====== [2025-02-07T07:59:57.752Z] ====== dec-tree (apache-spark) [default], iteration 24 started ====== [2025-02-07T07:59:58.080Z] GC before operation: completed in 219.939 ms, heap usage 271.882 MB -> 74.597 MB. [2025-02-07T07:59:59.713Z] ====== dec-tree (apache-spark) [default], iteration 24 completed (1287.753 ms) ====== [2025-02-07T07:59:59.713Z] ====== dec-tree (apache-spark) [default], iteration 25 started ====== [2025-02-07T07:59:59.713Z] GC before operation: completed in 190.636 ms, heap usage 266.906 MB -> 58.230 MB. [2025-02-07T08:00:00.845Z] ====== dec-tree (apache-spark) [default], iteration 25 completed (1394.449 ms) ====== [2025-02-07T08:00:00.845Z] ====== dec-tree (apache-spark) [default], iteration 26 started ====== [2025-02-07T08:00:01.172Z] GC before operation: completed in 220.559 ms, heap usage 250.388 MB -> 74.863 MB. [2025-02-07T08:00:02.831Z] ====== dec-tree (apache-spark) [default], iteration 26 completed (1396.210 ms) ====== [2025-02-07T08:00:02.831Z] ====== dec-tree (apache-spark) [default], iteration 27 started ====== [2025-02-07T08:00:02.831Z] GC before operation: completed in 217.089 ms, heap usage 267.012 MB -> 75.002 MB. [2025-02-07T08:00:04.444Z] ====== dec-tree (apache-spark) [default], iteration 27 completed (1373.833 ms) ====== [2025-02-07T08:00:04.444Z] ====== dec-tree (apache-spark) [default], iteration 28 started ====== [2025-02-07T08:00:04.444Z] GC before operation: completed in 211.325 ms, heap usage 267.818 MB -> 69.688 MB. [2025-02-07T08:00:05.559Z] ====== dec-tree (apache-spark) [default], iteration 28 completed (1290.873 ms) ====== [2025-02-07T08:00:05.559Z] ====== dec-tree (apache-spark) [default], iteration 29 started ====== [2025-02-07T08:00:05.888Z] GC before operation: completed in 240.136 ms, heap usage 258.076 MB -> 80.882 MB. [2025-02-07T08:00:07.490Z] ====== dec-tree (apache-spark) [default], iteration 29 completed (1283.818 ms) ====== [2025-02-07T08:00:07.490Z] ====== dec-tree (apache-spark) [default], iteration 30 started ====== [2025-02-07T08:00:07.490Z] GC before operation: completed in 196.283 ms, heap usage 273.842 MB -> 75.388 MB. [2025-02-07T08:00:08.623Z] ====== dec-tree (apache-spark) [default], iteration 30 completed (1235.612 ms) ====== [2025-02-07T08:00:08.623Z] ====== dec-tree (apache-spark) [default], iteration 31 started ====== [2025-02-07T08:00:08.953Z] GC before operation: completed in 198.422 ms, heap usage 273.600 MB -> 80.968 MB. [2025-02-07T08:00:10.175Z] ====== dec-tree (apache-spark) [default], iteration 31 completed (1328.687 ms) ====== [2025-02-07T08:00:10.175Z] ====== dec-tree (apache-spark) [default], iteration 32 started ====== [2025-02-07T08:00:10.505Z] GC before operation: completed in 228.812 ms, heap usage 278.421 MB -> 81.279 MB. [2025-02-07T08:00:10.505Z] 25/02/07 08:00:10 WARN BlockManager: Asked to remove block rdd_1565_1, which does not exist [2025-02-07T08:00:11.618Z] ====== dec-tree (apache-spark) [default], iteration 32 completed (1333.959 ms) ====== [2025-02-07T08:00:11.618Z] ====== dec-tree (apache-spark) [default], iteration 33 started ====== [2025-02-07T08:00:11.967Z] GC before operation: completed in 225.472 ms, heap usage 281.967 MB -> 75.783 MB. [2025-02-07T08:00:11.967Z] 25/02/07 08:00:11 WARN BlockManager: Asked to remove block rdd_1614_1, which does not exist [2025-02-07T08:00:13.105Z] ====== dec-tree (apache-spark) [default], iteration 33 completed (1270.678 ms) ====== [2025-02-07T08:00:13.105Z] ====== dec-tree (apache-spark) [default], iteration 34 started ====== [2025-02-07T08:00:13.435Z] GC before operation: completed in 211.515 ms, heap usage 280.153 MB -> 75.920 MB. [2025-02-07T08:00:15.063Z] ====== dec-tree (apache-spark) [default], iteration 34 completed (1373.611 ms) ====== [2025-02-07T08:00:15.064Z] ====== dec-tree (apache-spark) [default], iteration 35 started ====== [2025-02-07T08:00:15.064Z] GC before operation: completed in 212.955 ms, heap usage 270.043 MB -> 70.831 MB. [2025-02-07T08:00:16.327Z] ====== dec-tree (apache-spark) [default], iteration 35 completed (1448.096 ms) ====== [2025-02-07T08:00:16.327Z] ====== dec-tree (apache-spark) [default], iteration 36 started ====== [2025-02-07T08:00:16.649Z] GC before operation: completed in 188.768 ms, heap usage 263.705 MB -> 76.211 MB. [2025-02-07T08:00:17.785Z] ====== dec-tree (apache-spark) [default], iteration 36 completed (1245.245 ms) ====== [2025-02-07T08:00:17.785Z] ====== dec-tree (apache-spark) [default], iteration 37 started ====== [2025-02-07T08:00:18.111Z] GC before operation: completed in 211.234 ms, heap usage 263.741 MB -> 76.316 MB. [2025-02-07T08:00:19.751Z] ====== dec-tree (apache-spark) [default], iteration 37 completed (1285.017 ms) ====== [2025-02-07T08:00:19.751Z] ====== dec-tree (apache-spark) [default], iteration 38 started ====== [2025-02-07T08:00:19.751Z] GC before operation: completed in 209.887 ms, heap usage 264.760 MB -> 76.445 MB. [2025-02-07T08:00:19.751Z] 25/02/07 08:00:19 WARN BlockManager: Asked to remove block rdd_1859_0, which does not exist [2025-02-07T08:00:19.751Z] 25/02/07 08:00:19 WARN BlockManager: Asked to remove block rdd_1859_2, which does not exist [2025-02-07T08:00:20.861Z] ====== dec-tree (apache-spark) [default], iteration 38 completed (1316.908 ms) ====== [2025-02-07T08:00:20.861Z] ====== dec-tree (apache-spark) [default], iteration 39 started ====== [2025-02-07T08:00:21.191Z] GC before operation: completed in 223.171 ms, heap usage 262.747 MB -> 76.755 MB. [2025-02-07T08:00:22.855Z] ====== dec-tree (apache-spark) [default], iteration 39 completed (1406.001 ms) ====== [2025-02-07T08:00:22.855Z] ----------------------------------- [2025-02-07T08:00:22.855Z] renaissance-dec-tree_0_PASSED [2025-02-07T08:00:22.855Z] ----------------------------------- [2025-02-07T08:00:23.166Z] [2025-02-07T08:00:23.166Z] TEST TEARDOWN: [2025-02-07T08:00:23.166Z] Nothing to be done for teardown. [2025-02-07T08:00:23.491Z] renaissance-dec-tree_0 Finish Time: Fri Feb 7 08:00:23 2025 Epoch Time (ms): 1738915223093