[2025-05-28T19:53:56.120Z] Running test renaissance-dec-tree_0 ... [2025-05-28T19:53:56.120Z] =============================================== [2025-05-28T19:53:56.120Z] renaissance-dec-tree_0 Start Time: Wed May 28 15:53:55 2025 Epoch Time (ms): 1748462035797 [2025-05-28T19:53:56.120Z] variation: NoOptions [2025-05-28T19:53:56.120Z] JVM_OPTIONS: [2025-05-28T19:53:56.120Z] { \ [2025-05-28T19:53:56.120Z] echo ""; echo "TEST SETUP:"; \ [2025-05-28T19:53:56.120Z] echo "Nothing to be done for setup."; \ [2025-05-28T19:53:56.120Z] mkdir -p "/Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484618652318/renaissance-dec-tree_0"; \ [2025-05-28T19:53:56.120Z] cd "/Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484618652318/renaissance-dec-tree_0"; \ [2025-05-28T19:53:56.120Z] echo ""; echo "TESTING:"; \ [2025-05-28T19:53:56.120Z] "/Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/jdkbinary/j2sdk-image/Contents/Home/bin/..//bin/java" --add-opens java.base/java.lang=ALL-UNNAMED --add-opens java.base/java.util=ALL-UNNAMED --add-opens java.base/java.util.concurrent=ALL-UNNAMED --add-opens java.base/java.nio=ALL-UNNAMED --add-opens java.base/sun.nio.ch=ALL-UNNAMED --add-opens java.base/java.lang.invoke=ALL-UNNAMED -jar "/Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484618652318/renaissance-dec-tree_0"/dec-tree.json" dec-tree; \ [2025-05-28T19:53:56.120Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-dec-tree_0""_PASSED"; echo "-----------------------------------"; cd /Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/aqa-tests/TKG/..; rm -f -r "/Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484618652318/renaissance-dec-tree_0"; else echo "-----------------------------------"; echo "renaissance-dec-tree_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-05-28T19:53:56.120Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-05-28T19:53:56.120Z] echo "Nothing to be done for teardown."; \ [2025-05-28T19:53:56.120Z] } 2>&1 | tee -a "/Users/admin/workspace/workspace/Test_openjdk21_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484618652318/TestTargetResult"; [2025-05-28T19:53:56.120Z] [2025-05-28T19:53:56.120Z] TEST SETUP: [2025-05-28T19:53:56.121Z] Nothing to be done for setup. [2025-05-28T19:53:56.121Z] [2025-05-28T19:53:56.121Z] TESTING: [2025-05-28T19:53:59.264Z] NOTE: 'dec-tree' benchmark uses Spark local executor with 3 (out of 3) threads. [2025-05-28T19:54:00.519Z] ====== dec-tree (apache-spark) [default], iteration 0 started ====== [2025-05-28T19:54:00.519Z] GC before operation: completed in 38.205 ms, heap usage 75.852 MB -> 35.299 MB. [2025-05-28T19:54:05.568Z] ====== dec-tree (apache-spark) [default], iteration 0 completed (5080.232 ms) ====== [2025-05-28T19:54:05.568Z] ====== dec-tree (apache-spark) [default], iteration 1 started ====== [2025-05-28T19:54:05.568Z] GC before operation: completed in 53.453 ms, heap usage 405.033 MB -> 69.233 MB. [2025-05-28T19:54:06.837Z] ====== dec-tree (apache-spark) [default], iteration 1 completed (1077.640 ms) ====== [2025-05-28T19:54:06.837Z] ====== dec-tree (apache-spark) [default], iteration 2 started ====== [2025-05-28T19:54:06.837Z] GC before operation: completed in 53.670 ms, heap usage 287.684 MB -> 69.475 MB. [2025-05-28T19:54:08.131Z] ====== dec-tree (apache-spark) [default], iteration 2 completed (1009.930 ms) ====== [2025-05-28T19:54:08.131Z] ====== dec-tree (apache-spark) [default], iteration 3 started ====== [2025-05-28T19:54:08.131Z] GC before operation: completed in 70.009 ms, heap usage 155.975 MB -> 69.390 MB. [2025-05-28T19:54:08.914Z] ====== dec-tree (apache-spark) [default], iteration 3 completed (960.604 ms) ====== [2025-05-28T19:54:08.915Z] ====== dec-tree (apache-spark) [default], iteration 4 started ====== [2025-05-28T19:54:08.915Z] GC before operation: completed in 53.870 ms, heap usage 309.890 MB -> 70.082 MB. [2025-05-28T19:54:09.671Z] ====== dec-tree (apache-spark) [default], iteration 4 completed (885.389 ms) ====== [2025-05-28T19:54:09.671Z] ====== dec-tree (apache-spark) [default], iteration 5 started ====== [2025-05-28T19:54:10.096Z] GC before operation: completed in 44.817 ms, heap usage 144.692 MB -> 69.967 MB. [2025-05-28T19:54:10.882Z] ====== dec-tree (apache-spark) [default], iteration 5 completed (810.607 ms) ====== [2025-05-28T19:54:10.882Z] ====== dec-tree (apache-spark) [default], iteration 6 started ====== [2025-05-28T19:54:10.882Z] GC before operation: completed in 58.371 ms, heap usage 268.455 MB -> 70.399 MB. [2025-05-28T19:54:11.681Z] ====== dec-tree (apache-spark) [default], iteration 6 completed (982.381 ms) ====== [2025-05-28T19:54:11.681Z] ====== dec-tree (apache-spark) [default], iteration 7 started ====== [2025-05-28T19:54:11.681Z] GC before operation: completed in 69.497 ms, heap usage 315.103 MB -> 83.773 MB. [2025-05-28T19:54:12.943Z] ====== dec-tree (apache-spark) [default], iteration 7 completed (863.886 ms) ====== [2025-05-28T19:54:12.943Z] ====== dec-tree (apache-spark) [default], iteration 8 started ====== [2025-05-28T19:54:12.943Z] GC before operation: completed in 50.100 ms, heap usage 125.916 MB -> 70.161 MB. [2025-05-28T19:54:13.747Z] ====== dec-tree (apache-spark) [default], iteration 8 completed (795.362 ms) ====== [2025-05-28T19:54:13.747Z] ====== dec-tree (apache-spark) [default], iteration 9 started ====== [2025-05-28T19:54:13.747Z] GC before operation: completed in 48.390 ms, heap usage 122.370 MB -> 70.439 MB. [2025-05-28T19:54:14.522Z] ====== dec-tree (apache-spark) [default], iteration 9 completed (789.119 ms) ====== [2025-05-28T19:54:14.522Z] ====== dec-tree (apache-spark) [default], iteration 10 started ====== [2025-05-28T19:54:14.523Z] GC before operation: completed in 47.392 ms, heap usage 147.233 MB -> 70.694 MB. [2025-05-28T19:54:15.308Z] ====== dec-tree (apache-spark) [default], iteration 10 completed (857.140 ms) ====== [2025-05-28T19:54:15.308Z] ====== dec-tree (apache-spark) [default], iteration 11 started ====== [2025-05-28T19:54:15.308Z] GC before operation: completed in 61.740 ms, heap usage 254.902 MB -> 71.179 MB. [2025-05-28T19:54:16.110Z] ====== dec-tree (apache-spark) [default], iteration 11 completed (762.905 ms) ====== [2025-05-28T19:54:16.110Z] ====== dec-tree (apache-spark) [default], iteration 12 started ====== [2025-05-28T19:54:16.110Z] GC before operation: completed in 62.891 ms, heap usage 310.847 MB -> 71.311 MB. [2025-05-28T19:54:16.882Z] ====== dec-tree (apache-spark) [default], iteration 12 completed (667.438 ms) ====== [2025-05-28T19:54:16.882Z] ====== dec-tree (apache-spark) [default], iteration 13 started ====== [2025-05-28T19:54:16.882Z] GC before operation: completed in 43.738 ms, heap usage 318.482 MB -> 71.445 MB. [2025-05-28T19:54:17.681Z] ====== dec-tree (apache-spark) [default], iteration 13 completed (759.168 ms) ====== [2025-05-28T19:54:17.681Z] ====== dec-tree (apache-spark) [default], iteration 14 started ====== [2025-05-28T19:54:17.681Z] GC before operation: completed in 66.149 ms, heap usage 219.653 MB -> 71.569 MB. [2025-05-28T19:54:18.457Z] ====== dec-tree (apache-spark) [default], iteration 14 completed (745.264 ms) ====== [2025-05-28T19:54:18.457Z] ====== dec-tree (apache-spark) [default], iteration 15 started ====== [2025-05-28T19:54:18.457Z] GC before operation: completed in 52.179 ms, heap usage 158.182 MB -> 71.527 MB. [2025-05-28T19:54:19.245Z] ====== dec-tree (apache-spark) [default], iteration 15 completed (690.727 ms) ====== [2025-05-28T19:54:19.245Z] ====== dec-tree (apache-spark) [default], iteration 16 started ====== [2025-05-28T19:54:19.245Z] GC before operation: completed in 61.981 ms, heap usage 228.878 MB -> 71.862 MB. [2025-05-28T19:54:20.050Z] ====== dec-tree (apache-spark) [default], iteration 16 completed (706.760 ms) ====== [2025-05-28T19:54:20.050Z] ====== dec-tree (apache-spark) [default], iteration 17 started ====== [2025-05-28T19:54:20.050Z] GC before operation: completed in 50.367 ms, heap usage 284.883 MB -> 71.952 MB. [2025-05-28T19:54:20.811Z] ====== dec-tree (apache-spark) [default], iteration 17 completed (751.542 ms) ====== [2025-05-28T19:54:20.811Z] ====== dec-tree (apache-spark) [default], iteration 18 started ====== [2025-05-28T19:54:20.811Z] GC before operation: completed in 80.581 ms, heap usage 298.866 MB -> 72.084 MB. [2025-05-28T19:54:21.611Z] ====== dec-tree (apache-spark) [default], iteration 18 completed (739.560 ms) ====== [2025-05-28T19:54:21.611Z] ====== dec-tree (apache-spark) [default], iteration 19 started ====== [2025-05-28T19:54:21.611Z] GC before operation: completed in 58.269 ms, heap usage 301.203 MB -> 72.345 MB. [2025-05-28T19:54:22.391Z] ====== dec-tree (apache-spark) [default], iteration 19 completed (819.791 ms) ====== [2025-05-28T19:54:22.391Z] ====== dec-tree (apache-spark) [default], iteration 20 started ====== [2025-05-28T19:54:22.391Z] GC before operation: completed in 78.775 ms, heap usage 296.506 MB -> 72.334 MB. [2025-05-28T19:54:23.168Z] ====== dec-tree (apache-spark) [default], iteration 20 completed (770.337 ms) ====== [2025-05-28T19:54:23.168Z] ====== dec-tree (apache-spark) [default], iteration 21 started ====== [2025-05-28T19:54:23.168Z] GC before operation: completed in 69.200 ms, heap usage 313.842 MB -> 85.330 MB. [2025-05-28T19:54:23.949Z] ====== dec-tree (apache-spark) [default], iteration 21 completed (726.043 ms) ====== [2025-05-28T19:54:23.949Z] ====== dec-tree (apache-spark) [default], iteration 22 started ====== [2025-05-28T19:54:24.305Z] GC before operation: completed in 76.755 ms, heap usage 248.845 MB -> 72.670 MB. [2025-05-28T19:54:25.094Z] ====== dec-tree (apache-spark) [default], iteration 22 completed (701.644 ms) ====== [2025-05-28T19:54:25.094Z] ====== dec-tree (apache-spark) [default], iteration 23 started ====== [2025-05-28T19:54:25.094Z] GC before operation: completed in 72.517 ms, heap usage 300.776 MB -> 87.336 MB. [2025-05-28T19:54:25.867Z] ====== dec-tree (apache-spark) [default], iteration 23 completed (760.734 ms) ====== [2025-05-28T19:54:25.867Z] ====== dec-tree (apache-spark) [default], iteration 24 started ====== [2025-05-28T19:54:25.867Z] GC before operation: completed in 74.966 ms, heap usage 135.397 MB -> 72.462 MB. [2025-05-28T19:54:26.693Z] ====== dec-tree (apache-spark) [default], iteration 24 completed (772.577 ms) ====== [2025-05-28T19:54:26.693Z] ====== dec-tree (apache-spark) [default], iteration 25 started ====== [2025-05-28T19:54:26.693Z] GC before operation: completed in 80.043 ms, heap usage 327.966 MB -> 72.943 MB. [2025-05-28T19:54:27.466Z] ====== dec-tree (apache-spark) [default], iteration 25 completed (819.789 ms) ====== [2025-05-28T19:54:27.466Z] ====== dec-tree (apache-spark) [default], iteration 26 started ====== [2025-05-28T19:54:27.466Z] GC before operation: completed in 56.716 ms, heap usage 146.057 MB -> 72.686 MB. [2025-05-28T19:54:28.238Z] ====== dec-tree (apache-spark) [default], iteration 26 completed (787.075 ms) ====== [2025-05-28T19:54:28.238Z] ====== dec-tree (apache-spark) [default], iteration 27 started ====== [2025-05-28T19:54:28.238Z] GC before operation: completed in 75.476 ms, heap usage 298.305 MB -> 73.095 MB. [2025-05-28T19:54:29.022Z] ====== dec-tree (apache-spark) [default], iteration 27 completed (763.414 ms) ====== [2025-05-28T19:54:29.022Z] ====== dec-tree (apache-spark) [default], iteration 28 started ====== [2025-05-28T19:54:29.022Z] GC before operation: completed in 61.821 ms, heap usage 291.207 MB -> 73.177 MB. [2025-05-28T19:54:29.835Z] ====== dec-tree (apache-spark) [default], iteration 28 completed (738.899 ms) ====== [2025-05-28T19:54:29.835Z] ====== dec-tree (apache-spark) [default], iteration 29 started ====== [2025-05-28T19:54:29.835Z] GC before operation: completed in 82.517 ms, heap usage 292.180 MB -> 73.471 MB. [2025-05-28T19:54:31.067Z] ====== dec-tree (apache-spark) [default], iteration 29 completed (787.447 ms) ====== [2025-05-28T19:54:31.067Z] ====== dec-tree (apache-spark) [default], iteration 30 started ====== [2025-05-28T19:54:31.067Z] GC before operation: completed in 56.050 ms, heap usage 276.579 MB -> 73.601 MB. [2025-05-28T19:54:31.434Z] ====== dec-tree (apache-spark) [default], iteration 30 completed (714.655 ms) ====== [2025-05-28T19:54:31.434Z] ====== dec-tree (apache-spark) [default], iteration 31 started ====== [2025-05-28T19:54:31.815Z] GC before operation: completed in 94.903 ms, heap usage 273.702 MB -> 88.463 MB. [2025-05-28T19:54:32.576Z] ====== dec-tree (apache-spark) [default], iteration 31 completed (838.904 ms) ====== [2025-05-28T19:54:32.576Z] ====== dec-tree (apache-spark) [default], iteration 32 started ====== [2025-05-28T19:54:32.576Z] GC before operation: completed in 72.491 ms, heap usage 165.419 MB -> 73.599 MB. [2025-05-28T19:54:33.355Z] ====== dec-tree (apache-spark) [default], iteration 32 completed (766.542 ms) ====== [2025-05-28T19:54:33.355Z] ====== dec-tree (apache-spark) [default], iteration 33 started ====== [2025-05-28T19:54:33.355Z] GC before operation: completed in 70.474 ms, heap usage 124.737 MB -> 73.078 MB. [2025-05-28T19:54:34.179Z] ====== dec-tree (apache-spark) [default], iteration 33 completed (775.798 ms) ====== [2025-05-28T19:54:34.179Z] ====== dec-tree (apache-spark) [default], iteration 34 started ====== [2025-05-28T19:54:34.179Z] GC before operation: completed in 84.543 ms, heap usage 447.636 MB -> 74.164 MB. [2025-05-28T19:54:34.954Z] ====== dec-tree (apache-spark) [default], iteration 34 completed (718.070 ms) ====== [2025-05-28T19:54:34.954Z] ====== dec-tree (apache-spark) [default], iteration 35 started ====== [2025-05-28T19:54:34.954Z] GC before operation: completed in 80.792 ms, heap usage 296.810 MB -> 74.042 MB. [2025-05-28T19:54:35.724Z] ====== dec-tree (apache-spark) [default], iteration 35 completed (727.687 ms) ====== [2025-05-28T19:54:35.724Z] ====== dec-tree (apache-spark) [default], iteration 36 started ====== [2025-05-28T19:54:35.724Z] GC before operation: completed in 66.772 ms, heap usage 278.867 MB -> 99.683 MB. [2025-05-28T19:54:36.498Z] ====== dec-tree (apache-spark) [default], iteration 36 completed (743.266 ms) ====== [2025-05-28T19:54:36.498Z] ====== dec-tree (apache-spark) [default], iteration 37 started ====== [2025-05-28T19:54:36.498Z] GC before operation: completed in 71.754 ms, heap usage 140.808 MB -> 73.658 MB. [2025-05-28T19:54:37.778Z] ====== dec-tree (apache-spark) [default], iteration 37 completed (1061.824 ms) ====== [2025-05-28T19:54:37.778Z] ====== dec-tree (apache-spark) [default], iteration 38 started ====== [2025-05-28T19:54:37.778Z] GC before operation: completed in 64.874 ms, heap usage 325.255 MB -> 74.276 MB. [2025-05-28T19:54:38.571Z] ====== dec-tree (apache-spark) [default], iteration 38 completed (704.957 ms) ====== [2025-05-28T19:54:38.571Z] ====== dec-tree (apache-spark) [default], iteration 39 started ====== [2025-05-28T19:54:38.571Z] GC before operation: completed in 57.818 ms, heap usage 280.390 MB -> 74.412 MB. [2025-05-28T19:54:39.397Z] ====== dec-tree (apache-spark) [default], iteration 39 completed (717.330 ms) ====== [2025-05-28T19:54:39.397Z] ----------------------------------- [2025-05-28T19:54:39.397Z] renaissance-dec-tree_0_PASSED [2025-05-28T19:54:39.397Z] ----------------------------------- [2025-05-28T19:54:39.397Z] [2025-05-28T19:54:39.397Z] TEST TEARDOWN: [2025-05-28T19:54:39.397Z] Nothing to be done for teardown. [2025-05-28T19:54:39.397Z] renaissance-dec-tree_0 Finish Time: Wed May 28 15:54:39 2025 Epoch Time (ms): 1748462079241