[2025-05-01T12:44:11.313Z] Running test renaissance-dec-tree_0 ... [2025-05-01T12:44:11.313Z] =============================================== [2025-05-01T12:44:11.313Z] renaissance-dec-tree_0 Start Time: Thu May 1 12:44:10 2025 Epoch Time (ms): 1746103450511 [2025-05-01T12:44:11.313Z] variation: NoOptions [2025-05-01T12:44:11.313Z] JVM_OPTIONS: [2025-05-01T12:44:11.313Z] { \ [2025-05-01T12:44:11.313Z] echo ""; echo "TEST SETUP:"; \ [2025-05-01T12:44:11.313Z] echo "Nothing to be done for setup."; \ [2025-05-01T12:44:11.313Z] mkdir -p "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/aqa-tests/TKG/../TKG/output_17461030648982/renaissance-dec-tree_0"; \ [2025-05-01T12:44:11.313Z] cd "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/aqa-tests/TKG/../TKG/output_17461030648982/renaissance-dec-tree_0"; \ [2025-05-01T12:44:11.313Z] echo ""; echo "TESTING:"; \ [2025-05-01T12:44:11.313Z] "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/jdkbinary/j2sdk-image/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 "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/aqa-tests/TKG/../TKG/output_17461030648982/renaissance-dec-tree_0"/dec-tree.json" dec-tree; \ [2025-05-01T12:44:11.313Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-dec-tree_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/aqa-tests/TKG/../TKG/output_17461030648982/renaissance-dec-tree_0"; else echo "-----------------------------------"; echo "renaissance-dec-tree_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-05-01T12:44:11.313Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-05-01T12:44:11.313Z] echo "Nothing to be done for teardown."; \ [2025-05-01T12:44:11.313Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_ppc64_aix/aqa-tests/TKG/../TKG/output_17461030648982/TestTargetResult"; [2025-05-01T12:44:11.313Z] [2025-05-01T12:44:11.313Z] TEST SETUP: [2025-05-01T12:44:11.313Z] Nothing to be done for setup. [2025-05-01T12:44:11.313Z] [2025-05-01T12:44:11.313Z] TESTING: [2025-05-01T12:44:18.316Z] NOTE: 'dec-tree' benchmark uses Spark local executor with 6 (out of 24) threads. [2025-05-01T12:44:20.837Z] ====== dec-tree (apache-spark) [default], iteration 0 started ====== [2025-05-01T12:44:20.837Z] GC before operation: completed in 84.367 ms, heap usage 37.285 MB -> 34.710 MB. [2025-05-01T12:44:30.863Z] ====== dec-tree (apache-spark) [default], iteration 0 completed (9366.977 ms) ====== [2025-05-01T12:44:30.863Z] ====== dec-tree (apache-spark) [default], iteration 1 started ====== [2025-05-01T12:44:30.863Z] GC before operation: completed in 101.537 ms, heap usage 396.841 MB -> 71.045 MB. [2025-05-01T12:44:32.483Z] ====== dec-tree (apache-spark) [default], iteration 1 completed (1961.695 ms) ====== [2025-05-01T12:44:32.483Z] ====== dec-tree (apache-spark) [default], iteration 2 started ====== [2025-05-01T12:44:32.483Z] GC before operation: completed in 96.624 ms, heap usage 143.858 MB -> 70.975 MB. [2025-05-01T12:44:34.102Z] ====== dec-tree (apache-spark) [default], iteration 2 completed (1675.533 ms) ====== [2025-05-01T12:44:34.103Z] ====== dec-tree (apache-spark) [default], iteration 3 started ====== [2025-05-01T12:44:34.888Z] GC before operation: completed in 96.565 ms, heap usage 361.819 MB -> 71.488 MB. [2025-05-01T12:44:36.512Z] ====== dec-tree (apache-spark) [default], iteration 3 completed (1652.434 ms) ====== [2025-05-01T12:44:36.512Z] ====== dec-tree (apache-spark) [default], iteration 4 started ====== [2025-05-01T12:44:36.512Z] GC before operation: completed in 100.116 ms, heap usage 320.010 MB -> 71.906 MB. [2025-05-01T12:44:38.129Z] ====== dec-tree (apache-spark) [default], iteration 4 completed (1621.054 ms) ====== [2025-05-01T12:44:38.129Z] ====== dec-tree (apache-spark) [default], iteration 5 started ====== [2025-05-01T12:44:38.129Z] GC before operation: completed in 97.350 ms, heap usage 234.111 MB -> 71.937 MB. [2025-05-01T12:44:39.752Z] ====== dec-tree (apache-spark) [default], iteration 5 completed (1585.711 ms) ====== [2025-05-01T12:44:39.752Z] ====== dec-tree (apache-spark) [default], iteration 6 started ====== [2025-05-01T12:44:39.752Z] GC before operation: completed in 109.883 ms, heap usage 422.104 MB -> 72.300 MB. [2025-05-01T12:44:41.373Z] ====== dec-tree (apache-spark) [default], iteration 6 completed (1543.204 ms) ====== [2025-05-01T12:44:41.373Z] ====== dec-tree (apache-spark) [default], iteration 7 started ====== [2025-05-01T12:44:41.373Z] GC before operation: completed in 104.506 ms, heap usage 122.894 MB -> 71.740 MB. [2025-05-01T12:44:43.003Z] ====== dec-tree (apache-spark) [default], iteration 7 completed (1552.524 ms) ====== [2025-05-01T12:44:43.003Z] ====== dec-tree (apache-spark) [default], iteration 8 started ====== [2025-05-01T12:44:43.003Z] GC before operation: completed in 112.127 ms, heap usage 198.324 MB -> 72.362 MB. [2025-05-01T12:44:44.628Z] ====== dec-tree (apache-spark) [default], iteration 8 completed (1508.143 ms) ====== [2025-05-01T12:44:44.628Z] ====== dec-tree (apache-spark) [default], iteration 9 started ====== [2025-05-01T12:44:44.628Z] GC before operation: completed in 121.609 ms, heap usage 182.600 MB -> 72.367 MB. [2025-05-01T12:44:46.246Z] ====== dec-tree (apache-spark) [default], iteration 9 completed (1527.644 ms) ====== [2025-05-01T12:44:46.246Z] ====== dec-tree (apache-spark) [default], iteration 10 started ====== [2025-05-01T12:44:46.246Z] GC before operation: completed in 114.346 ms, heap usage 297.939 MB -> 78.397 MB. [2025-05-01T12:44:47.877Z] ====== dec-tree (apache-spark) [default], iteration 10 completed (1494.716 ms) ====== [2025-05-01T12:44:47.877Z] ====== dec-tree (apache-spark) [default], iteration 11 started ====== [2025-05-01T12:44:47.877Z] GC before operation: completed in 110.176 ms, heap usage 376.000 MB -> 72.946 MB. [2025-05-01T12:44:49.499Z] ====== dec-tree (apache-spark) [default], iteration 11 completed (1496.584 ms) ====== [2025-05-01T12:44:49.499Z] ====== dec-tree (apache-spark) [default], iteration 12 started ====== [2025-05-01T12:44:49.499Z] GC before operation: completed in 126.600 ms, heap usage 372.148 MB -> 84.352 MB. [2025-05-01T12:44:51.123Z] ====== dec-tree (apache-spark) [default], iteration 12 completed (1483.380 ms) ====== [2025-05-01T12:44:51.123Z] ====== dec-tree (apache-spark) [default], iteration 13 started ====== [2025-05-01T12:44:51.123Z] GC before operation: completed in 124.721 ms, heap usage 274.710 MB -> 73.328 MB. [2025-05-01T12:44:52.742Z] ====== dec-tree (apache-spark) [default], iteration 13 completed (1489.523 ms) ====== [2025-05-01T12:44:52.742Z] ====== dec-tree (apache-spark) [default], iteration 14 started ====== [2025-05-01T12:44:52.742Z] GC before operation: completed in 118.797 ms, heap usage 260.890 MB -> 73.449 MB. [2025-05-01T12:44:54.363Z] ====== dec-tree (apache-spark) [default], iteration 14 completed (1467.223 ms) ====== [2025-05-01T12:44:54.363Z] ====== dec-tree (apache-spark) [default], iteration 15 started ====== [2025-05-01T12:44:54.363Z] GC before operation: completed in 128.721 ms, heap usage 117.628 MB -> 72.799 MB. [2025-05-01T12:44:55.986Z] ====== dec-tree (apache-spark) [default], iteration 15 completed (1491.838 ms) ====== [2025-05-01T12:44:55.986Z] ====== dec-tree (apache-spark) [default], iteration 16 started ====== [2025-05-01T12:44:55.986Z] GC before operation: completed in 123.629 ms, heap usage 501.245 MB -> 73.797 MB. [2025-05-01T12:44:57.607Z] ====== dec-tree (apache-spark) [default], iteration 16 completed (1465.205 ms) ====== [2025-05-01T12:44:57.608Z] ====== dec-tree (apache-spark) [default], iteration 17 started ====== [2025-05-01T12:44:57.608Z] GC before operation: completed in 124.266 ms, heap usage 290.138 MB -> 84.834 MB. [2025-05-01T12:44:59.232Z] ====== dec-tree (apache-spark) [default], iteration 17 completed (1463.467 ms) ====== [2025-05-01T12:44:59.232Z] ====== dec-tree (apache-spark) [default], iteration 18 started ====== [2025-05-01T12:44:59.232Z] GC before operation: completed in 127.481 ms, heap usage 359.078 MB -> 84.743 MB. [2025-05-01T12:45:00.855Z] ====== dec-tree (apache-spark) [default], iteration 18 completed (1486.126 ms) ====== [2025-05-01T12:45:00.856Z] ====== dec-tree (apache-spark) [default], iteration 19 started ====== [2025-05-01T12:45:00.856Z] GC before operation: completed in 125.292 ms, heap usage 118.270 MB -> 73.327 MB. [2025-05-01T12:45:02.490Z] ====== dec-tree (apache-spark) [default], iteration 19 completed (1487.375 ms) ====== [2025-05-01T12:45:02.490Z] ====== dec-tree (apache-spark) [default], iteration 20 started ====== [2025-05-01T12:45:02.490Z] GC before operation: completed in 139.521 ms, heap usage 411.777 MB -> 85.359 MB. [2025-05-01T12:45:04.127Z] ====== dec-tree (apache-spark) [default], iteration 20 completed (1447.760 ms) ====== [2025-05-01T12:45:04.127Z] ====== dec-tree (apache-spark) [default], iteration 21 started ====== [2025-05-01T12:45:04.127Z] GC before operation: completed in 136.805 ms, heap usage 484.763 MB -> 79.751 MB. [2025-05-01T12:45:05.792Z] ====== dec-tree (apache-spark) [default], iteration 21 completed (1456.199 ms) ====== [2025-05-01T12:45:05.792Z] ====== dec-tree (apache-spark) [default], iteration 22 started ====== [2025-05-01T12:45:05.792Z] GC before operation: completed in 130.145 ms, heap usage 149.403 MB -> 74.380 MB. [2025-05-01T12:45:07.413Z] ====== dec-tree (apache-spark) [default], iteration 22 completed (1463.159 ms) ====== [2025-05-01T12:45:07.413Z] ====== dec-tree (apache-spark) [default], iteration 23 started ====== [2025-05-01T12:45:07.413Z] GC before operation: completed in 132.157 ms, heap usage 293.921 MB -> 74.562 MB. [2025-05-01T12:45:08.202Z] ====== dec-tree (apache-spark) [default], iteration 23 completed (1451.362 ms) ====== [2025-05-01T12:45:08.202Z] ====== dec-tree (apache-spark) [default], iteration 24 started ====== [2025-05-01T12:45:08.986Z] GC before operation: completed in 129.915 ms, heap usage 147.005 MB -> 74.327 MB. [2025-05-01T12:45:09.783Z] ====== dec-tree (apache-spark) [default], iteration 24 completed (1438.499 ms) ====== [2025-05-01T12:45:09.783Z] ====== dec-tree (apache-spark) [default], iteration 25 started ====== [2025-05-01T12:45:10.570Z] GC before operation: completed in 130.669 ms, heap usage 213.490 MB -> 75.018 MB. [2025-05-01T12:45:13.595Z] ====== dec-tree (apache-spark) [default], iteration 25 completed (1460.800 ms) ====== [2025-05-01T12:45:13.595Z] ====== dec-tree (apache-spark) [default], iteration 26 started ====== [2025-05-01T12:45:13.595Z] GC before operation: completed in 128.990 ms, heap usage 186.342 MB -> 74.421 MB. [2025-05-01T12:45:15.233Z] ====== dec-tree (apache-spark) [default], iteration 26 completed (1456.298 ms) ====== [2025-05-01T12:45:15.233Z] ====== dec-tree (apache-spark) [default], iteration 27 started ====== [2025-05-01T12:45:15.233Z] GC before operation: completed in 132.630 ms, heap usage 212.945 MB -> 74.842 MB. [2025-05-01T12:45:15.233Z] ====== dec-tree (apache-spark) [default], iteration 27 completed (1445.466 ms) ====== [2025-05-01T12:45:15.233Z] ====== dec-tree (apache-spark) [default], iteration 28 started ====== [2025-05-01T12:45:15.233Z] GC before operation: completed in 136.137 ms, heap usage 270.908 MB -> 85.836 MB. [2025-05-01T12:45:16.851Z] ====== dec-tree (apache-spark) [default], iteration 28 completed (1438.176 ms) ====== [2025-05-01T12:45:16.851Z] ====== dec-tree (apache-spark) [default], iteration 29 started ====== [2025-05-01T12:45:16.851Z] GC before operation: completed in 138.475 ms, heap usage 482.509 MB -> 86.101 MB. [2025-05-01T12:45:18.469Z] ====== dec-tree (apache-spark) [default], iteration 29 completed (1446.797 ms) ====== [2025-05-01T12:45:18.469Z] ====== dec-tree (apache-spark) [default], iteration 30 started ====== [2025-05-01T12:45:18.469Z] GC before operation: completed in 141.423 ms, heap usage 297.414 MB -> 75.515 MB. [2025-05-01T12:45:19.254Z] ====== dec-tree (apache-spark) [default], iteration 30 completed (1405.262 ms) ====== [2025-05-01T12:45:19.254Z] ====== dec-tree (apache-spark) [default], iteration 31 started ====== [2025-05-01T12:45:20.037Z] GC before operation: completed in 146.640 ms, heap usage 117.626 MB -> 74.777 MB. [2025-05-01T12:45:20.843Z] ====== dec-tree (apache-spark) [default], iteration 31 completed (1444.129 ms) ====== [2025-05-01T12:45:20.843Z] ====== dec-tree (apache-spark) [default], iteration 32 started ====== [2025-05-01T12:45:21.631Z] GC before operation: completed in 148.904 ms, heap usage 545.108 MB -> 75.762 MB. [2025-05-01T12:45:22.417Z] ====== dec-tree (apache-spark) [default], iteration 32 completed (1438.985 ms) ====== [2025-05-01T12:45:22.417Z] ====== dec-tree (apache-spark) [default], iteration 33 started ====== [2025-05-01T12:45:23.207Z] GC before operation: completed in 139.279 ms, heap usage 201.078 MB -> 80.594 MB. [2025-05-01T12:45:24.006Z] ====== dec-tree (apache-spark) [default], iteration 33 completed (1421.202 ms) ====== [2025-05-01T12:45:24.006Z] ====== dec-tree (apache-spark) [default], iteration 34 started ====== [2025-05-01T12:45:24.790Z] GC before operation: completed in 136.254 ms, heap usage 308.833 MB -> 75.734 MB. [2025-05-01T12:45:25.583Z] ====== dec-tree (apache-spark) [default], iteration 34 completed (1422.499 ms) ====== [2025-05-01T12:45:25.583Z] ====== dec-tree (apache-spark) [default], iteration 35 started ====== [2025-05-01T12:45:26.368Z] GC before operation: completed in 139.558 ms, heap usage 164.740 MB -> 75.376 MB. [2025-05-01T12:45:27.154Z] ====== dec-tree (apache-spark) [default], iteration 35 completed (1426.531 ms) ====== [2025-05-01T12:45:27.154Z] ====== dec-tree (apache-spark) [default], iteration 36 started ====== [2025-05-01T12:45:27.945Z] GC before operation: completed in 134.943 ms, heap usage 117.365 MB -> 75.192 MB. [2025-05-01T12:45:28.730Z] ====== dec-tree (apache-spark) [default], iteration 36 completed (1421.496 ms) ====== [2025-05-01T12:45:28.730Z] ====== dec-tree (apache-spark) [default], iteration 37 started ====== [2025-05-01T12:45:29.522Z] GC before operation: completed in 145.735 ms, heap usage 510.509 MB -> 86.977 MB. [2025-05-01T12:45:30.308Z] ====== dec-tree (apache-spark) [default], iteration 37 completed (1419.435 ms) ====== [2025-05-01T12:45:30.308Z] ====== dec-tree (apache-spark) [default], iteration 38 started ====== [2025-05-01T12:45:31.092Z] GC before operation: completed in 135.637 ms, heap usage 478.862 MB -> 75.815 MB. [2025-05-01T12:45:31.878Z] ====== dec-tree (apache-spark) [default], iteration 38 completed (1414.795 ms) ====== [2025-05-01T12:45:31.878Z] ====== dec-tree (apache-spark) [default], iteration 39 started ====== [2025-05-01T12:45:32.662Z] GC before operation: completed in 154.119 ms, heap usage 431.214 MB -> 86.961 MB. [2025-05-01T12:45:33.451Z] ====== dec-tree (apache-spark) [default], iteration 39 completed (1417.850 ms) ====== [2025-05-01T12:45:34.237Z] ----------------------------------- [2025-05-01T12:45:34.237Z] renaissance-dec-tree_0_PASSED [2025-05-01T12:45:34.237Z] ----------------------------------- [2025-05-01T12:45:34.237Z] [2025-05-01T12:45:34.237Z] TEST TEARDOWN: [2025-05-01T12:45:34.237Z] Nothing to be done for teardown. [2025-05-01T12:45:34.237Z] renaissance-dec-tree_0 Finish Time: Thu May 1 12:45:33 2025 Epoch Time (ms): 1746103533578