[2025-05-28T21:03:29.973Z] Running test renaissance-dec-tree_0 ... [2025-05-28T21:03:29.973Z] =============================================== [2025-05-28T21:03:29.973Z] renaissance-dec-tree_0 Start Time: Wed May 28 17:03:29 2025 Epoch Time (ms): 1748466209847 [2025-05-28T21:03:29.973Z] variation: NoOptions [2025-05-28T21:03:29.973Z] JVM_OPTIONS: [2025-05-28T21:03:29.973Z] { \ [2025-05-28T21:03:29.973Z] echo ""; echo "TEST SETUP:"; \ [2025-05-28T21:03:29.973Z] echo "Nothing to be done for setup."; \ [2025-05-28T21:03:29.973Z] mkdir -p "/Users/admin/workspace/workspace/Test_openjdk17_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484660466246/renaissance-dec-tree_0"; \ [2025-05-28T21:03:29.973Z] cd "/Users/admin/workspace/workspace/Test_openjdk17_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484660466246/renaissance-dec-tree_0"; \ [2025-05-28T21:03:29.973Z] echo ""; echo "TESTING:"; \ [2025-05-28T21:03:29.973Z] "/Users/admin/workspace/workspace/Test_openjdk17_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_openjdk17_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/Users/admin/workspace/workspace/Test_openjdk17_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484660466246/renaissance-dec-tree_0"/dec-tree.json" dec-tree; \ [2025-05-28T21:03:29.973Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-dec-tree_0""_PASSED"; echo "-----------------------------------"; cd /Users/admin/workspace/workspace/Test_openjdk17_hs_extended.perf_aarch64_mac/aqa-tests/TKG/..; rm -f -r "/Users/admin/workspace/workspace/Test_openjdk17_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484660466246/renaissance-dec-tree_0"; else echo "-----------------------------------"; echo "renaissance-dec-tree_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-05-28T21:03:29.974Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-05-28T21:03:29.974Z] echo "Nothing to be done for teardown."; \ [2025-05-28T21:03:29.974Z] } 2>&1 | tee -a "/Users/admin/workspace/workspace/Test_openjdk17_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17484660466246/TestTargetResult"; [2025-05-28T21:03:29.974Z] [2025-05-28T21:03:29.974Z] TEST SETUP: [2025-05-28T21:03:29.974Z] Nothing to be done for setup. [2025-05-28T21:03:29.974Z] [2025-05-28T21:03:29.974Z] TESTING: [2025-05-28T21:03:34.021Z] NOTE: 'dec-tree' benchmark uses Spark local executor with 3 (out of 3) threads. [2025-05-28T21:03:34.779Z] ====== dec-tree (apache-spark) [default], iteration 0 started ====== [2025-05-28T21:03:34.779Z] GC before operation: completed in 20.452 ms, heap usage 74.665 MB -> 35.032 MB. [2025-05-28T21:03:39.875Z] ====== dec-tree (apache-spark) [default], iteration 0 completed (5298.625 ms) ====== [2025-05-28T21:03:39.875Z] ====== dec-tree (apache-spark) [default], iteration 1 started ====== [2025-05-28T21:03:39.875Z] GC before operation: completed in 51.235 ms, heap usage 342.920 MB -> 69.019 MB. [2025-05-28T21:03:41.132Z] ====== dec-tree (apache-spark) [default], iteration 1 completed (1230.693 ms) ====== [2025-05-28T21:03:41.132Z] ====== dec-tree (apache-spark) [default], iteration 2 started ====== [2025-05-28T21:03:41.488Z] GC before operation: completed in 34.183 ms, heap usage 125.600 MB -> 69.094 MB. [2025-05-28T21:03:42.318Z] ====== dec-tree (apache-spark) [default], iteration 2 completed (963.159 ms) ====== [2025-05-28T21:03:42.318Z] ====== dec-tree (apache-spark) [default], iteration 3 started ====== [2025-05-28T21:03:42.318Z] GC before operation: completed in 49.530 ms, heap usage 257.636 MB -> 82.751 MB. [2025-05-28T21:03:43.100Z] ====== dec-tree (apache-spark) [default], iteration 3 completed (846.957 ms) ====== [2025-05-28T21:03:43.100Z] ====== dec-tree (apache-spark) [default], iteration 4 started ====== [2025-05-28T21:03:43.100Z] GC before operation: completed in 48.326 ms, heap usage 118.343 MB -> 69.577 MB. [2025-05-28T21:03:44.338Z] ====== dec-tree (apache-spark) [default], iteration 4 completed (865.853 ms) ====== [2025-05-28T21:03:44.338Z] ====== dec-tree (apache-spark) [default], iteration 5 started ====== [2025-05-28T21:03:44.338Z] GC before operation: completed in 52.383 ms, heap usage 113.433 MB -> 69.627 MB. [2025-05-28T21:03:45.132Z] ====== dec-tree (apache-spark) [default], iteration 5 completed (896.091 ms) ====== [2025-05-28T21:03:45.132Z] ====== dec-tree (apache-spark) [default], iteration 6 started ====== [2025-05-28T21:03:45.132Z] GC before operation: completed in 37.756 ms, heap usage 458.632 MB -> 70.356 MB. [2025-05-28T21:03:45.910Z] ====== dec-tree (apache-spark) [default], iteration 6 completed (786.980 ms) ====== [2025-05-28T21:03:45.910Z] ====== dec-tree (apache-spark) [default], iteration 7 started ====== [2025-05-28T21:03:45.910Z] GC before operation: completed in 45.459 ms, heap usage 277.640 MB -> 70.525 MB. [2025-05-28T21:03:46.689Z] ====== dec-tree (apache-spark) [default], iteration 7 completed (847.259 ms) ====== [2025-05-28T21:03:46.689Z] ====== dec-tree (apache-spark) [default], iteration 8 started ====== [2025-05-28T21:03:46.689Z] GC before operation: completed in 38.047 ms, heap usage 117.893 MB -> 70.053 MB. [2025-05-28T21:03:47.477Z] ====== dec-tree (apache-spark) [default], iteration 8 completed (804.533 ms) ====== [2025-05-28T21:03:47.477Z] ====== dec-tree (apache-spark) [default], iteration 9 started ====== [2025-05-28T21:03:47.830Z] GC before operation: completed in 58.216 ms, heap usage 337.871 MB -> 70.826 MB. [2025-05-28T21:03:48.588Z] ====== dec-tree (apache-spark) [default], iteration 9 completed (744.695 ms) ====== [2025-05-28T21:03:48.588Z] ====== dec-tree (apache-spark) [default], iteration 10 started ====== [2025-05-28T21:03:48.588Z] GC before operation: completed in 38.648 ms, heap usage 277.682 MB -> 70.932 MB. [2025-05-28T21:03:49.346Z] ====== dec-tree (apache-spark) [default], iteration 10 completed (836.681 ms) ====== [2025-05-28T21:03:49.346Z] ====== dec-tree (apache-spark) [default], iteration 11 started ====== [2025-05-28T21:03:49.347Z] GC before operation: completed in 40.384 ms, heap usage 116.982 MB -> 70.443 MB. [2025-05-28T21:03:50.148Z] ====== dec-tree (apache-spark) [default], iteration 11 completed (786.828 ms) ====== [2025-05-28T21:03:50.148Z] ====== dec-tree (apache-spark) [default], iteration 12 started ====== [2025-05-28T21:03:50.148Z] GC before operation: completed in 54.406 ms, heap usage 225.131 MB -> 71.212 MB. [2025-05-28T21:03:50.965Z] ====== dec-tree (apache-spark) [default], iteration 12 completed (716.211 ms) ====== [2025-05-28T21:03:50.965Z] ====== dec-tree (apache-spark) [default], iteration 13 started ====== [2025-05-28T21:03:50.965Z] GC before operation: completed in 62.987 ms, heap usage 272.245 MB -> 71.379 MB. [2025-05-28T21:03:51.753Z] ====== dec-tree (apache-spark) [default], iteration 13 completed (749.467 ms) ====== [2025-05-28T21:03:51.753Z] ====== dec-tree (apache-spark) [default], iteration 14 started ====== [2025-05-28T21:03:51.753Z] GC before operation: completed in 41.401 ms, heap usage 268.554 MB -> 71.474 MB. [2025-05-28T21:03:52.544Z] ====== dec-tree (apache-spark) [default], iteration 14 completed (909.273 ms) ====== [2025-05-28T21:03:52.544Z] ====== dec-tree (apache-spark) [default], iteration 15 started ====== [2025-05-28T21:03:52.544Z] GC before operation: completed in 63.748 ms, heap usage 264.996 MB -> 71.722 MB. [2025-05-28T21:03:53.325Z] ====== dec-tree (apache-spark) [default], iteration 15 completed (769.905 ms) ====== [2025-05-28T21:03:53.325Z] ====== dec-tree (apache-spark) [default], iteration 16 started ====== [2025-05-28T21:03:53.696Z] GC before operation: completed in 42.863 ms, heap usage 107.453 MB -> 71.252 MB. [2025-05-28T21:03:54.974Z] ====== dec-tree (apache-spark) [default], iteration 16 completed (1263.175 ms) ====== [2025-05-28T21:03:54.974Z] ====== dec-tree (apache-spark) [default], iteration 17 started ====== [2025-05-28T21:03:54.974Z] GC before operation: completed in 67.625 ms, heap usage 409.252 MB -> 71.903 MB. [2025-05-28T21:03:55.735Z] ====== dec-tree (apache-spark) [default], iteration 17 completed (697.231 ms) ====== [2025-05-28T21:03:55.735Z] ====== dec-tree (apache-spark) [default], iteration 18 started ====== [2025-05-28T21:03:55.735Z] GC before operation: completed in 62.935 ms, heap usage 271.077 MB -> 84.953 MB. [2025-05-28T21:03:56.494Z] ====== dec-tree (apache-spark) [default], iteration 18 completed (722.842 ms) ====== [2025-05-28T21:03:56.494Z] ====== dec-tree (apache-spark) [default], iteration 19 started ====== [2025-05-28T21:03:56.494Z] GC before operation: completed in 46.813 ms, heap usage 235.808 MB -> 72.148 MB. [2025-05-28T21:03:57.260Z] ====== dec-tree (apache-spark) [default], iteration 19 completed (659.740 ms) ====== [2025-05-28T21:03:57.260Z] ====== dec-tree (apache-spark) [default], iteration 20 started ====== [2025-05-28T21:03:57.260Z] GC before operation: completed in 45.434 ms, heap usage 262.658 MB -> 72.245 MB. [2025-05-28T21:03:58.044Z] ====== dec-tree (apache-spark) [default], iteration 20 completed (763.497 ms) ====== [2025-05-28T21:03:58.044Z] ====== dec-tree (apache-spark) [default], iteration 21 started ====== [2025-05-28T21:03:58.044Z] GC before operation: completed in 62.771 ms, heap usage 261.821 MB -> 72.391 MB. [2025-05-28T21:03:58.813Z] ====== dec-tree (apache-spark) [default], iteration 21 completed (735.249 ms) ====== [2025-05-28T21:03:58.813Z] ====== dec-tree (apache-spark) [default], iteration 22 started ====== [2025-05-28T21:03:58.813Z] GC before operation: completed in 63.430 ms, heap usage 260.678 MB -> 72.534 MB. [2025-05-28T21:03:59.582Z] ====== dec-tree (apache-spark) [default], iteration 22 completed (641.590 ms) ====== [2025-05-28T21:03:59.582Z] ====== dec-tree (apache-spark) [default], iteration 23 started ====== [2025-05-28T21:03:59.582Z] GC before operation: completed in 45.852 ms, heap usage 260.115 MB -> 72.713 MB. [2025-05-28T21:03:59.937Z] ====== dec-tree (apache-spark) [default], iteration 23 completed (651.503 ms) ====== [2025-05-28T21:03:59.937Z] ====== dec-tree (apache-spark) [default], iteration 24 started ====== [2025-05-28T21:03:59.937Z] GC before operation: completed in 48.147 ms, heap usage 372.838 MB -> 72.649 MB. [2025-05-28T21:04:00.712Z] ====== dec-tree (apache-spark) [default], iteration 24 completed (777.452 ms) ====== [2025-05-28T21:04:00.712Z] ====== dec-tree (apache-spark) [default], iteration 25 started ====== [2025-05-28T21:04:01.079Z] GC before operation: completed in 61.142 ms, heap usage 114.029 MB -> 99.993 MB. [2025-05-28T21:04:01.436Z] ====== dec-tree (apache-spark) [default], iteration 25 completed (664.426 ms) ====== [2025-05-28T21:04:01.436Z] ====== dec-tree (apache-spark) [default], iteration 26 started ====== [2025-05-28T21:04:01.801Z] GC before operation: completed in 46.044 ms, heap usage 199.413 MB -> 72.641 MB. [2025-05-28T21:04:02.163Z] ====== dec-tree (apache-spark) [default], iteration 26 completed (679.676 ms) ====== [2025-05-28T21:04:02.163Z] ====== dec-tree (apache-spark) [default], iteration 27 started ====== [2025-05-28T21:04:02.524Z] GC before operation: completed in 45.816 ms, heap usage 117.600 MB -> 72.408 MB. [2025-05-28T21:04:02.891Z] ====== dec-tree (apache-spark) [default], iteration 27 completed (678.444 ms) ====== [2025-05-28T21:04:02.891Z] ====== dec-tree (apache-spark) [default], iteration 28 started ====== [2025-05-28T21:04:03.264Z] GC before operation: completed in 63.747 ms, heap usage 413.553 MB -> 73.132 MB. [2025-05-28T21:04:04.040Z] ====== dec-tree (apache-spark) [default], iteration 28 completed (703.370 ms) ====== [2025-05-28T21:04:04.040Z] ====== dec-tree (apache-spark) [default], iteration 29 started ====== [2025-05-28T21:04:04.040Z] GC before operation: completed in 60.017 ms, heap usage 237.932 MB -> 73.260 MB. [2025-05-28T21:04:04.405Z] ====== dec-tree (apache-spark) [default], iteration 29 completed (671.037 ms) ====== [2025-05-28T21:04:04.405Z] ====== dec-tree (apache-spark) [default], iteration 30 started ====== [2025-05-28T21:04:04.761Z] GC before operation: completed in 47.091 ms, heap usage 263.544 MB -> 73.332 MB. [2025-05-28T21:04:05.118Z] ====== dec-tree (apache-spark) [default], iteration 30 completed (693.385 ms) ====== [2025-05-28T21:04:05.118Z] ====== dec-tree (apache-spark) [default], iteration 31 started ====== [2025-05-28T21:04:05.495Z] GC before operation: completed in 69.688 ms, heap usage 242.467 MB -> 73.474 MB. [2025-05-28T21:04:06.259Z] ====== dec-tree (apache-spark) [default], iteration 31 completed (677.684 ms) ====== [2025-05-28T21:04:06.259Z] ====== dec-tree (apache-spark) [default], iteration 32 started ====== [2025-05-28T21:04:06.259Z] GC before operation: completed in 73.564 ms, heap usage 229.441 MB -> 73.537 MB. [2025-05-28T21:04:07.019Z] ====== dec-tree (apache-spark) [default], iteration 32 completed (703.453 ms) ====== [2025-05-28T21:04:07.019Z] ====== dec-tree (apache-spark) [default], iteration 33 started ====== [2025-05-28T21:04:07.019Z] GC before operation: completed in 47.459 ms, heap usage 228.754 MB -> 73.664 MB. [2025-05-28T21:04:07.780Z] ====== dec-tree (apache-spark) [default], iteration 33 completed (695.869 ms) ====== [2025-05-28T21:04:07.780Z] ====== dec-tree (apache-spark) [default], iteration 34 started ====== [2025-05-28T21:04:07.780Z] GC before operation: completed in 69.279 ms, heap usage 240.685 MB -> 88.696 MB. [2025-05-28T21:04:08.585Z] ====== dec-tree (apache-spark) [default], iteration 34 completed (716.439 ms) ====== [2025-05-28T21:04:08.585Z] ====== dec-tree (apache-spark) [default], iteration 35 started ====== [2025-05-28T21:04:08.585Z] GC before operation: completed in 54.443 ms, heap usage 136.003 MB -> 73.755 MB. [2025-05-28T21:04:08.959Z] ====== dec-tree (apache-spark) [default], iteration 35 completed (711.427 ms) ====== [2025-05-28T21:04:08.959Z] ====== dec-tree (apache-spark) [default], iteration 36 started ====== [2025-05-28T21:04:09.321Z] GC before operation: completed in 52.424 ms, heap usage 117.152 MB -> 86.479 MB. [2025-05-28T21:04:09.708Z] ====== dec-tree (apache-spark) [default], iteration 36 completed (664.543 ms) ====== [2025-05-28T21:04:09.708Z] ====== dec-tree (apache-spark) [default], iteration 37 started ====== [2025-05-28T21:04:10.078Z] GC before operation: completed in 73.290 ms, heap usage 290.452 MB -> 74.140 MB. [2025-05-28T21:04:10.433Z] ====== dec-tree (apache-spark) [default], iteration 37 completed (660.606 ms) ====== [2025-05-28T21:04:10.433Z] ====== dec-tree (apache-spark) [default], iteration 38 started ====== [2025-05-28T21:04:10.788Z] GC before operation: completed in 60.186 ms, heap usage 222.459 MB -> 74.262 MB. [2025-05-28T21:04:11.145Z] ====== dec-tree (apache-spark) [default], iteration 38 completed (670.697 ms) ====== [2025-05-28T21:04:11.145Z] ====== dec-tree (apache-spark) [default], iteration 39 started ====== [2025-05-28T21:04:11.506Z] GC before operation: completed in 71.907 ms, heap usage 233.043 MB -> 74.346 MB. [2025-05-28T21:04:11.859Z] ====== dec-tree (apache-spark) [default], iteration 39 completed (649.627 ms) ====== [2025-05-28T21:04:12.213Z] ----------------------------------- [2025-05-28T21:04:12.213Z] renaissance-dec-tree_0_PASSED [2025-05-28T21:04:12.213Z] ----------------------------------- [2025-05-28T21:04:12.213Z] [2025-05-28T21:04:12.213Z] TEST TEARDOWN: [2025-05-28T21:04:12.213Z] Nothing to be done for teardown. [2025-05-28T21:04:12.213Z] renaissance-dec-tree_0 Finish Time: Wed May 28 17:04:11 2025 Epoch Time (ms): 1748466251962