[2026-01-20T23:08:59.014Z] Running test renaissance-log-regression_0 ... [2026-01-20T23:08:59.014Z] =============================================== [2026-01-20T23:08:59.014Z] renaissance-log-regression_0 Start Time: Tue Jan 20 23:08:58 2026 Epoch Time (ms): 1768950538742 [2026-01-20T23:08:59.014Z] variation: NoOptions [2026-01-20T23:08:59.014Z] JVM_OPTIONS: [2026-01-20T23:08:59.014Z] { \ [2026-01-20T23:08:59.014Z] echo ""; echo "TEST SETUP:"; \ [2026-01-20T23:08:59.014Z] echo "Nothing to be done for setup."; \ [2026-01-20T23:08:59.014Z] mkdir -p "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-log-regression_0"; \ [2026-01-20T23:08:59.015Z] cd "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-log-regression_0"; \ [2026-01-20T23:08:59.015Z] echo ""; echo "TESTING:"; \ [2026-01-20T23:08:59.015Z] "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/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_aarch64_linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-log-regression_0"/log-regression.json" log-regression; \ [2026-01-20T23:08:59.015Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-log-regression_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/renaissance-log-regression_0"; else echo "-----------------------------------"; echo "renaissance-log-regression_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-01-20T23:08:59.015Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-01-20T23:08:59.015Z] echo "Nothing to be done for teardown."; \ [2026-01-20T23:08:59.015Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk17_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17689495185189/TestTargetResult"; [2026-01-20T23:08:59.015Z] [2026-01-20T23:08:59.015Z] TEST SETUP: [2026-01-20T23:08:59.015Z] Nothing to be done for setup. [2026-01-20T23:08:59.015Z] [2026-01-20T23:08:59.015Z] TESTING: [2026-01-20T23:09:06.711Z] NOTE: 'log-regression' benchmark uses Spark local executor with 4 (out of 4) threads. [2026-01-20T23:09:09.921Z] ====== log-regression (apache-spark) [default], iteration 0 started ====== [2026-01-20T23:09:09.921Z] GC before operation: completed in 54.156 ms, heap usage 54.487 MB -> 34.890 MB. [2026-01-20T23:09:26.621Z] ====== log-regression (apache-spark) [default], iteration 0 completed (15434.556 ms) ====== [2026-01-20T23:09:26.621Z] ====== log-regression (apache-spark) [default], iteration 1 started ====== [2026-01-20T23:09:26.621Z] GC before operation: completed in 84.267 ms, heap usage 360.391 MB -> 119.601 MB. [2026-01-20T23:09:29.170Z] ====== log-regression (apache-spark) [default], iteration 1 completed (3492.229 ms) ====== [2026-01-20T23:09:29.170Z] ====== log-regression (apache-spark) [default], iteration 2 started ====== [2026-01-20T23:09:29.170Z] GC before operation: completed in 79.793 ms, heap usage 339.378 MB -> 120.092 MB. [2026-01-20T23:09:31.702Z] ====== log-regression (apache-spark) [default], iteration 2 completed (2895.824 ms) ====== [2026-01-20T23:09:31.702Z] ====== log-regression (apache-spark) [default], iteration 3 started ====== [2026-01-20T23:09:32.091Z] GC before operation: completed in 89.091 ms, heap usage 431.641 MB -> 120.864 MB. [2026-01-20T23:09:34.630Z] ====== log-regression (apache-spark) [default], iteration 3 completed (2478.009 ms) ====== [2026-01-20T23:09:34.630Z] ====== log-regression (apache-spark) [default], iteration 4 started ====== [2026-01-20T23:09:34.630Z] GC before operation: completed in 77.881 ms, heap usage 313.861 MB -> 120.665 MB. [2026-01-20T23:09:37.143Z] ====== log-regression (apache-spark) [default], iteration 4 completed (2273.455 ms) ====== [2026-01-20T23:09:37.143Z] ====== log-regression (apache-spark) [default], iteration 5 started ====== [2026-01-20T23:09:37.143Z] GC before operation: completed in 78.359 ms, heap usage 500.158 MB -> 121.550 MB. [2026-01-20T23:09:39.000Z] ====== log-regression (apache-spark) [default], iteration 5 completed (2088.971 ms) ====== [2026-01-20T23:09:39.001Z] ====== log-regression (apache-spark) [default], iteration 6 started ====== [2026-01-20T23:09:39.001Z] GC before operation: completed in 81.723 ms, heap usage 278.474 MB -> 121.099 MB. [2026-01-20T23:09:40.914Z] ====== log-regression (apache-spark) [default], iteration 6 completed (2106.656 ms) ====== [2026-01-20T23:09:40.914Z] ====== log-regression (apache-spark) [default], iteration 7 started ====== [2026-01-20T23:09:41.300Z] GC before operation: completed in 83.066 ms, heap usage 259.259 MB -> 121.212 MB. [2026-01-20T23:09:43.210Z] ====== log-regression (apache-spark) [default], iteration 7 completed (1995.624 ms) ====== [2026-01-20T23:09:43.210Z] ====== log-regression (apache-spark) [default], iteration 8 started ====== [2026-01-20T23:09:43.210Z] GC before operation: completed in 84.468 ms, heap usage 552.132 MB -> 122.295 MB. [2026-01-20T23:09:45.710Z] ====== log-regression (apache-spark) [default], iteration 8 completed (2002.410 ms) ====== [2026-01-20T23:09:45.710Z] ====== log-regression (apache-spark) [default], iteration 9 started ====== [2026-01-20T23:09:45.710Z] GC before operation: completed in 86.725 ms, heap usage 262.127 MB -> 121.668 MB. [2026-01-20T23:09:47.599Z] ====== log-regression (apache-spark) [default], iteration 9 completed (2057.768 ms) ====== [2026-01-20T23:09:47.599Z] ====== log-regression (apache-spark) [default], iteration 10 started ====== [2026-01-20T23:09:47.599Z] GC before operation: completed in 93.654 ms, heap usage 376.595 MB -> 122.329 MB. [2026-01-20T23:09:49.513Z] ====== log-regression (apache-spark) [default], iteration 10 completed (2073.122 ms) ====== [2026-01-20T23:09:49.513Z] ====== log-regression (apache-spark) [default], iteration 11 started ====== [2026-01-20T23:09:49.513Z] GC before operation: completed in 89.437 ms, heap usage 276.055 MB -> 122.219 MB. [2026-01-20T23:09:52.016Z] ====== log-regression (apache-spark) [default], iteration 11 completed (1956.213 ms) ====== [2026-01-20T23:09:52.016Z] ====== log-regression (apache-spark) [default], iteration 12 started ====== [2026-01-20T23:09:52.016Z] GC before operation: completed in 90.287 ms, heap usage 346.882 MB -> 122.574 MB. [2026-01-20T23:09:53.889Z] ====== log-regression (apache-spark) [default], iteration 12 completed (1885.615 ms) ====== [2026-01-20T23:09:53.889Z] ====== log-regression (apache-spark) [default], iteration 13 started ====== [2026-01-20T23:09:53.889Z] GC before operation: completed in 88.902 ms, heap usage 258.233 MB -> 122.435 MB. [2026-01-20T23:09:55.771Z] ====== log-regression (apache-spark) [default], iteration 13 completed (1956.216 ms) ====== [2026-01-20T23:09:55.771Z] ====== log-regression (apache-spark) [default], iteration 14 started ====== [2026-01-20T23:09:55.771Z] GC before operation: completed in 86.791 ms, heap usage 354.264 MB -> 122.958 MB. [2026-01-20T23:09:57.753Z] ====== log-regression (apache-spark) [default], iteration 14 completed (1922.288 ms) ====== [2026-01-20T23:09:57.753Z] ====== log-regression (apache-spark) [default], iteration 15 started ====== [2026-01-20T23:09:57.753Z] GC before operation: completed in 82.233 ms, heap usage 274.694 MB -> 122.980 MB. [2026-01-20T23:09:59.720Z] ====== log-regression (apache-spark) [default], iteration 15 completed (1881.088 ms) ====== [2026-01-20T23:09:59.720Z] ====== log-regression (apache-spark) [default], iteration 16 started ====== [2026-01-20T23:09:59.720Z] GC before operation: completed in 97.534 ms, heap usage 402.488 MB -> 123.675 MB. [2026-01-20T23:10:01.591Z] ====== log-regression (apache-spark) [default], iteration 16 completed (1847.095 ms) ====== [2026-01-20T23:10:01.591Z] ====== log-regression (apache-spark) [default], iteration 17 started ====== [2026-01-20T23:10:01.591Z] GC before operation: completed in 89.434 ms, heap usage 265.006 MB -> 123.299 MB. [2026-01-20T23:10:03.492Z] ====== log-regression (apache-spark) [default], iteration 17 completed (1997.550 ms) ====== [2026-01-20T23:10:03.492Z] ====== log-regression (apache-spark) [default], iteration 18 started ====== [2026-01-20T23:10:03.879Z] GC before operation: completed in 91.282 ms, heap usage 426.443 MB -> 124.053 MB. [2026-01-20T23:10:05.850Z] ====== log-regression (apache-spark) [default], iteration 18 completed (1899.338 ms) ====== [2026-01-20T23:10:05.850Z] ====== log-regression (apache-spark) [default], iteration 19 started ====== [2026-01-20T23:10:05.850Z] GC before operation: completed in 95.266 ms, heap usage 330.234 MB -> 123.867 MB. [2026-01-20T23:10:07.747Z] ====== log-regression (apache-spark) [default], iteration 19 completed (1875.321 ms) ====== [2026-01-20T23:10:08.119Z] ----------------------------------- [2026-01-20T23:10:08.119Z] renaissance-log-regression_0_PASSED [2026-01-20T23:10:08.119Z] ----------------------------------- [2026-01-20T23:10:08.119Z] [2026-01-20T23:10:08.119Z] TEST TEARDOWN: [2026-01-20T23:10:08.119Z] Nothing to be done for teardown. [2026-01-20T23:10:08.119Z] renaissance-log-regression_0 Finish Time: Tue Jan 20 23:10:07 2026 Epoch Time (ms): 1768950607757