[2025-12-13T13:18:55.755Z] Running test renaissance-dec-tree_0 ... [2025-12-13T13:18:55.755Z] =============================================== [2025-12-13T13:18:55.755Z] renaissance-dec-tree_0 Start Time: Sat Dec 13 08:18:55 2025 Epoch Time (ms): 1765631935418 [2025-12-13T13:18:55.755Z] variation: NoOptions [2025-12-13T13:18:55.755Z] JVM_OPTIONS: [2025-12-13T13:18:55.755Z] { \ [2025-12-13T13:18:55.755Z] echo ""; echo "TEST SETUP:"; \ [2025-12-13T13:18:55.755Z] echo "Nothing to be done for setup."; \ [2025-12-13T13:18:55.755Z] mkdir -p "/Users/admin/workspace/workspace/Test_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17656316961245/renaissance-dec-tree_0"; \ [2025-12-13T13:18:55.755Z] cd "/Users/admin/workspace/workspace/Test_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17656316961245/renaissance-dec-tree_0"; \ [2025-12-13T13:18:55.755Z] echo ""; echo "TESTING:"; \ [2025-12-13T13:18:55.755Z] "/Users/admin/workspace/workspace/Test_openjdk25_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_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/Users/admin/workspace/workspace/Test_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17656316961245/renaissance-dec-tree_0"/dec-tree.json" dec-tree; \ [2025-12-13T13:18:55.755Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-dec-tree_0""_PASSED"; echo "-----------------------------------"; cd /Users/admin/workspace/workspace/Test_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/..; rm -f -r "/Users/admin/workspace/workspace/Test_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17656316961245/renaissance-dec-tree_0"; else echo "-----------------------------------"; echo "renaissance-dec-tree_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-12-13T13:18:55.755Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-12-13T13:18:55.755Z] echo "Nothing to be done for teardown."; \ [2025-12-13T13:18:55.755Z] } 2>&1 | tee -a "/Users/admin/workspace/workspace/Test_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/../TKG/output_17656316961245/TestTargetResult"; [2025-12-13T13:18:55.755Z] [2025-12-13T13:18:55.755Z] TEST SETUP: [2025-12-13T13:18:55.755Z] Nothing to be done for setup. [2025-12-13T13:18:55.755Z] [2025-12-13T13:18:55.755Z] TESTING: [2025-12-13T13:18:56.119Z] WARNING: A terminally deprecated method in sun.misc.Unsafe has been called [2025-12-13T13:18:56.119Z] WARNING: sun.misc.Unsafe::objectFieldOffset has been called by scala.runtime.LazyVals$ (file:/Users/admin/workspace/workspace/Test_openjdk25_hs_extended.perf_aarch64_mac/aqa-tests/TKG/output_17656316961245/renaissance-dec-tree_0/launcher-081855-2810522621607607001/renaissance-harness_3/lib/scala3-library_3-3.3.4.jar) [2025-12-13T13:18:56.119Z] WARNING: Please consider reporting this to the maintainers of class scala.runtime.LazyVals$ [2025-12-13T13:18:56.119Z] WARNING: sun.misc.Unsafe::objectFieldOffset will be removed in a future release [2025-12-13T13:19:00.197Z] NOTE: 'dec-tree' benchmark uses Spark local executor with 4 (out of 4) threads. [2025-12-13T13:19:01.465Z] ====== dec-tree (apache-spark) [default], iteration 0 started ====== [2025-12-13T13:19:01.465Z] GC before operation: completed in 30.609 ms, heap usage 45.425 MB -> 35.396 MB. [2025-12-13T13:19:07.827Z] ====== dec-tree (apache-spark) [default], iteration 0 completed (5553.602 ms) ====== [2025-12-13T13:19:07.828Z] ====== dec-tree (apache-spark) [default], iteration 1 started ====== [2025-12-13T13:19:07.828Z] GC before operation: completed in 59.258 ms, heap usage 221.925 MB -> 69.130 MB. [2025-12-13T13:19:08.610Z] ====== dec-tree (apache-spark) [default], iteration 1 completed (1176.243 ms) ====== [2025-12-13T13:19:08.610Z] ====== dec-tree (apache-spark) [default], iteration 2 started ====== [2025-12-13T13:19:08.610Z] GC before operation: completed in 39.561 ms, heap usage 231.376 MB -> 75.141 MB. [2025-12-13T13:19:09.389Z] ====== dec-tree (apache-spark) [default], iteration 2 completed (1095.267 ms) ====== [2025-12-13T13:19:09.389Z] ====== dec-tree (apache-spark) [default], iteration 3 started ====== [2025-12-13T13:19:09.754Z] GC before operation: completed in 45.295 ms, heap usage 145.482 MB -> 96.954 MB. [2025-12-13T13:19:10.578Z] ====== dec-tree (apache-spark) [default], iteration 3 completed (1001.464 ms) ====== [2025-12-13T13:19:10.578Z] ====== dec-tree (apache-spark) [default], iteration 4 started ====== [2025-12-13T13:19:10.578Z] GC before operation: completed in 46.959 ms, heap usage 343.034 MB -> 69.900 MB. [2025-12-13T13:19:11.388Z] ====== dec-tree (apache-spark) [default], iteration 4 completed (927.991 ms) ====== [2025-12-13T13:19:11.388Z] ====== dec-tree (apache-spark) [default], iteration 5 started ====== [2025-12-13T13:19:11.773Z] GC before operation: completed in 49.548 ms, heap usage 325.422 MB -> 81.048 MB. [2025-12-13T13:19:12.547Z] ====== dec-tree (apache-spark) [default], iteration 5 completed (838.148 ms) ====== [2025-12-13T13:19:12.547Z] ====== dec-tree (apache-spark) [default], iteration 6 started ====== [2025-12-13T13:19:12.547Z] GC before operation: completed in 37.467 ms, heap usage 218.586 MB -> 70.253 MB. [2025-12-13T13:19:13.345Z] ====== dec-tree (apache-spark) [default], iteration 6 completed (827.803 ms) ====== [2025-12-13T13:19:13.345Z] ====== dec-tree (apache-spark) [default], iteration 7 started ====== [2025-12-13T13:19:13.345Z] GC before operation: completed in 42.717 ms, heap usage 162.523 MB -> 70.296 MB. [2025-12-13T13:19:14.144Z] ====== dec-tree (apache-spark) [default], iteration 7 completed (903.977 ms) ====== [2025-12-13T13:19:14.144Z] ====== dec-tree (apache-spark) [default], iteration 8 started ====== [2025-12-13T13:19:14.144Z] GC before operation: completed in 39.275 ms, heap usage 106.801 MB -> 70.363 MB. [2025-12-13T13:19:15.385Z] ====== dec-tree (apache-spark) [default], iteration 8 completed (885.089 ms) ====== [2025-12-13T13:19:15.385Z] ====== dec-tree (apache-spark) [default], iteration 9 started ====== [2025-12-13T13:19:15.385Z] GC before operation: completed in 50.695 ms, heap usage 212.052 MB -> 70.785 MB. [2025-12-13T13:19:16.161Z] ====== dec-tree (apache-spark) [default], iteration 9 completed (785.668 ms) ====== [2025-12-13T13:19:16.161Z] ====== dec-tree (apache-spark) [default], iteration 10 started ====== [2025-12-13T13:19:16.161Z] GC before operation: completed in 48.183 ms, heap usage 294.438 MB -> 71.029 MB. [2025-12-13T13:19:16.953Z] ====== dec-tree (apache-spark) [default], iteration 10 completed (804.724 ms) ====== [2025-12-13T13:19:16.953Z] ====== dec-tree (apache-spark) [default], iteration 11 started ====== [2025-12-13T13:19:16.953Z] GC before operation: completed in 63.905 ms, heap usage 301.616 MB -> 71.090 MB. [2025-12-13T13:19:17.740Z] ====== dec-tree (apache-spark) [default], iteration 11 completed (826.037 ms) ====== [2025-12-13T13:19:17.740Z] ====== dec-tree (apache-spark) [default], iteration 12 started ====== [2025-12-13T13:19:17.740Z] GC before operation: completed in 48.555 ms, heap usage 298.096 MB -> 71.134 MB. [2025-12-13T13:19:18.532Z] ====== dec-tree (apache-spark) [default], iteration 12 completed (765.566 ms) ====== [2025-12-13T13:19:18.532Z] ====== dec-tree (apache-spark) [default], iteration 13 started ====== [2025-12-13T13:19:18.532Z] GC before operation: completed in 48.118 ms, heap usage 301.776 MB -> 82.400 MB. [2025-12-13T13:19:19.335Z] ====== dec-tree (apache-spark) [default], iteration 13 completed (749.137 ms) ====== [2025-12-13T13:19:19.335Z] ====== dec-tree (apache-spark) [default], iteration 14 started ====== [2025-12-13T13:19:19.335Z] GC before operation: completed in 54.883 ms, heap usage 374.645 MB -> 71.439 MB. [2025-12-13T13:19:20.122Z] ====== dec-tree (apache-spark) [default], iteration 14 completed (789.524 ms) ====== [2025-12-13T13:19:20.122Z] ====== dec-tree (apache-spark) [default], iteration 15 started ====== [2025-12-13T13:19:20.122Z] GC before operation: completed in 59.363 ms, heap usage 216.457 MB -> 82.461 MB. [2025-12-13T13:19:21.393Z] ====== dec-tree (apache-spark) [default], iteration 15 completed (801.786 ms) ====== [2025-12-13T13:19:21.393Z] ====== dec-tree (apache-spark) [default], iteration 16 started ====== [2025-12-13T13:19:21.393Z] GC before operation: completed in 53.109 ms, heap usage 168.149 MB -> 71.373 MB. [2025-12-13T13:19:21.770Z] ====== dec-tree (apache-spark) [default], iteration 16 completed (745.191 ms) ====== [2025-12-13T13:19:21.770Z] ====== dec-tree (apache-spark) [default], iteration 17 started ====== [2025-12-13T13:19:21.770Z] GC before operation: completed in 55.685 ms, heap usage 268.571 MB -> 71.773 MB. [2025-12-13T13:19:22.586Z] ====== dec-tree (apache-spark) [default], iteration 17 completed (786.207 ms) ====== [2025-12-13T13:19:22.586Z] ====== dec-tree (apache-spark) [default], iteration 18 started ====== [2025-12-13T13:19:22.952Z] GC before operation: completed in 58.347 ms, heap usage 289.729 MB -> 82.890 MB. [2025-12-13T13:19:23.832Z] ====== dec-tree (apache-spark) [default], iteration 18 completed (798.281 ms) ====== [2025-12-13T13:19:23.832Z] ====== dec-tree (apache-spark) [default], iteration 19 started ====== [2025-12-13T13:19:23.832Z] GC before operation: completed in 58.289 ms, heap usage 335.249 MB -> 83.069 MB. [2025-12-13T13:19:24.625Z] ====== dec-tree (apache-spark) [default], iteration 19 completed (782.646 ms) ====== [2025-12-13T13:19:24.625Z] ====== dec-tree (apache-spark) [default], iteration 20 started ====== [2025-12-13T13:19:24.625Z] GC before operation: completed in 56.106 ms, heap usage 193.262 MB -> 71.768 MB. [2025-12-13T13:19:25.435Z] ====== dec-tree (apache-spark) [default], iteration 20 completed (783.114 ms) ====== [2025-12-13T13:19:25.435Z] ====== dec-tree (apache-spark) [default], iteration 21 started ====== [2025-12-13T13:19:25.435Z] GC before operation: completed in 63.786 ms, heap usage 256.017 MB -> 72.350 MB. [2025-12-13T13:19:26.233Z] ====== dec-tree (apache-spark) [default], iteration 21 completed (801.389 ms) ====== [2025-12-13T13:19:26.233Z] ====== dec-tree (apache-spark) [default], iteration 22 started ====== [2025-12-13T13:19:26.233Z] GC before operation: completed in 59.189 ms, heap usage 115.960 MB -> 71.841 MB. [2025-12-13T13:19:27.014Z] ====== dec-tree (apache-spark) [default], iteration 22 completed (786.729 ms) ====== [2025-12-13T13:19:27.014Z] ====== dec-tree (apache-spark) [default], iteration 23 started ====== [2025-12-13T13:19:27.014Z] GC before operation: completed in 55.990 ms, heap usage 185.626 MB -> 72.164 MB. [2025-12-13T13:19:27.779Z] ====== dec-tree (apache-spark) [default], iteration 23 completed (797.025 ms) ====== [2025-12-13T13:19:27.779Z] ====== dec-tree (apache-spark) [default], iteration 24 started ====== [2025-12-13T13:19:27.779Z] GC before operation: completed in 61.136 ms, heap usage 277.055 MB -> 72.980 MB. [2025-12-13T13:19:27.779Z] 08:19:27.693 WARN [block-manager-storage-async-thread-pool-26] org.apache.spark.storage.BlockManager - Asked to remove block broadcast_331, which does not exist [2025-12-13T13:19:28.545Z] ====== dec-tree (apache-spark) [default], iteration 24 completed (752.235 ms) ====== [2025-12-13T13:19:28.546Z] ====== dec-tree (apache-spark) [default], iteration 25 started ====== [2025-12-13T13:19:28.546Z] GC before operation: completed in 58.180 ms, heap usage 270.929 MB -> 78.113 MB. [2025-12-13T13:19:29.775Z] ====== dec-tree (apache-spark) [default], iteration 25 completed (802.996 ms) ====== [2025-12-13T13:19:29.775Z] ====== dec-tree (apache-spark) [default], iteration 26 started ====== [2025-12-13T13:19:29.775Z] GC before operation: completed in 58.228 ms, heap usage 232.711 MB -> 83.785 MB. [2025-12-13T13:19:30.173Z] ====== dec-tree (apache-spark) [default], iteration 26 completed (753.433 ms) ====== [2025-12-13T13:19:30.173Z] ====== dec-tree (apache-spark) [default], iteration 27 started ====== [2025-12-13T13:19:30.535Z] GC before operation: completed in 55.749 ms, heap usage 359.921 MB -> 83.737 MB. [2025-12-13T13:19:31.314Z] ====== dec-tree (apache-spark) [default], iteration 27 completed (791.128 ms) ====== [2025-12-13T13:19:31.314Z] ====== dec-tree (apache-spark) [default], iteration 28 started ====== [2025-12-13T13:19:31.314Z] GC before operation: completed in 58.852 ms, heap usage 357.767 MB -> 89.409 MB. [2025-12-13T13:19:32.097Z] ====== dec-tree (apache-spark) [default], iteration 28 completed (745.818 ms) ====== [2025-12-13T13:19:32.097Z] ====== dec-tree (apache-spark) [default], iteration 29 started ====== [2025-12-13T13:19:32.097Z] GC before operation: completed in 56.800 ms, heap usage 164.512 MB -> 100.478 MB. [2025-12-13T13:19:32.861Z] ====== dec-tree (apache-spark) [default], iteration 29 completed (739.574 ms) ====== [2025-12-13T13:19:32.861Z] ====== dec-tree (apache-spark) [default], iteration 30 started ====== [2025-12-13T13:19:32.861Z] GC before operation: completed in 51.483 ms, heap usage 146.474 MB -> 73.015 MB. [2025-12-13T13:19:33.650Z] ====== dec-tree (apache-spark) [default], iteration 30 completed (830.691 ms) ====== [2025-12-13T13:19:33.650Z] ====== dec-tree (apache-spark) [default], iteration 31 started ====== [2025-12-13T13:19:33.650Z] GC before operation: completed in 51.822 ms, heap usage 267.404 MB -> 73.471 MB. [2025-12-13T13:19:34.429Z] ====== dec-tree (apache-spark) [default], iteration 31 completed (840.411 ms) ====== [2025-12-13T13:19:34.429Z] ====== dec-tree (apache-spark) [default], iteration 32 started ====== [2025-12-13T13:19:34.429Z] GC before operation: completed in 59.725 ms, heap usage 442.444 MB -> 90.367 MB. [2025-12-13T13:19:35.688Z] ====== dec-tree (apache-spark) [default], iteration 32 completed (791.650 ms) ====== [2025-12-13T13:19:35.688Z] ====== dec-tree (apache-spark) [default], iteration 33 started ====== [2025-12-13T13:19:35.688Z] GC before operation: completed in 53.056 ms, heap usage 346.109 MB -> 79.133 MB. [2025-12-13T13:19:36.071Z] ====== dec-tree (apache-spark) [default], iteration 33 completed (790.483 ms) ====== [2025-12-13T13:19:36.071Z] ====== dec-tree (apache-spark) [default], iteration 34 started ====== [2025-12-13T13:19:36.444Z] GC before operation: completed in 65.997 ms, heap usage 369.324 MB -> 79.385 MB. [2025-12-13T13:19:37.243Z] ====== dec-tree (apache-spark) [default], iteration 34 completed (758.136 ms) ====== [2025-12-13T13:19:37.243Z] ====== dec-tree (apache-spark) [default], iteration 35 started ====== [2025-12-13T13:19:37.243Z] GC before operation: completed in 54.458 ms, heap usage 386.928 MB -> 74.008 MB. [2025-12-13T13:19:38.028Z] ====== dec-tree (apache-spark) [default], iteration 35 completed (751.548 ms) ====== [2025-12-13T13:19:38.028Z] ====== dec-tree (apache-spark) [default], iteration 36 started ====== [2025-12-13T13:19:38.028Z] GC before operation: completed in 59.361 ms, heap usage 308.551 MB -> 73.957 MB. [2025-12-13T13:19:38.798Z] ====== dec-tree (apache-spark) [default], iteration 36 completed (784.604 ms) ====== [2025-12-13T13:19:38.799Z] ====== dec-tree (apache-spark) [default], iteration 37 started ====== [2025-12-13T13:19:38.799Z] GC before operation: completed in 64.737 ms, heap usage 442.456 MB -> 101.846 MB. [2025-12-13T13:19:39.581Z] ====== dec-tree (apache-spark) [default], iteration 37 completed (757.500 ms) ====== [2025-12-13T13:19:39.581Z] ====== dec-tree (apache-spark) [default], iteration 38 started ====== [2025-12-13T13:19:39.581Z] GC before operation: completed in 67.917 ms, heap usage 141.325 MB -> 73.937 MB. [2025-12-13T13:19:40.364Z] ====== dec-tree (apache-spark) [default], iteration 38 completed (849.899 ms) ====== [2025-12-13T13:19:40.364Z] ====== dec-tree (apache-spark) [default], iteration 39 started ====== [2025-12-13T13:19:40.364Z] GC before operation: completed in 69.329 ms, heap usage 471.432 MB -> 102.086 MB. [2025-12-13T13:19:40.364Z] 08:19:40.322 WARN [block-manager-storage-async-thread-pool-54] org.apache.spark.storage.BlockManager - Asked to remove block broadcast_545, which does not exist [2025-12-13T13:19:41.182Z] ====== dec-tree (apache-spark) [default], iteration 39 completed (762.119 ms) ====== [2025-12-13T13:19:41.542Z] ----------------------------------- [2025-12-13T13:19:41.542Z] renaissance-dec-tree_0_PASSED [2025-12-13T13:19:41.542Z] ----------------------------------- [2025-12-13T13:19:41.542Z] [2025-12-13T13:19:41.542Z] TEST TEARDOWN: [2025-12-13T13:19:41.542Z] Nothing to be done for teardown. [2025-12-13T13:19:41.542Z] renaissance-dec-tree_0 Finish Time: Sat Dec 13 08:19:41 2025 Epoch Time (ms): 1765631981296