[2026-02-12T16:53:56.138Z] Running test renaissance-als_0 ... [2026-02-12T16:53:56.138Z] =============================================== [2026-02-12T16:53:56.138Z] renaissance-als_0 Start Time: Thu Feb 12 16:53:55 2026 Epoch Time (ms): 1770915235862 [2026-02-12T16:53:56.138Z] variation: NoOptions [2026-02-12T16:53:56.138Z] JVM_OPTIONS: [2026-02-12T16:53:56.138Z] { \ [2026-02-12T16:53:56.138Z] echo ""; echo "TEST SETUP:"; \ [2026-02-12T16:53:56.138Z] echo "Nothing to be done for setup."; \ [2026-02-12T16:53:56.138Z] mkdir -p "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17709150538184/renaissance-als_0"; \ [2026-02-12T16:53:56.138Z] cd "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17709150538184/renaissance-als_0"; \ [2026-02-12T16:53:56.138Z] echo ""; echo "TESTING:"; \ [2026-02-12T16:53:56.138Z] "/home/jenkins/workspace/Test_openjdk21_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_openjdk21_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17709150538184/renaissance-als_0"/als.json" als; \ [2026-02-12T16:53:56.138Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-als_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17709150538184/renaissance-als_0"; else echo "-----------------------------------"; echo "renaissance-als_0""_FAILED"; echo "-----------------------------------"; fi; \ [2026-02-12T16:53:56.138Z] echo ""; echo "TEST TEARDOWN:"; \ [2026-02-12T16:53:56.138Z] echo "Nothing to be done for teardown."; \ [2026-02-12T16:53:56.138Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk21_hs_extended.perf_aarch64_linux/aqa-tests/TKG/../TKG/output_17709150538184/TestTargetResult"; [2026-02-12T16:53:56.138Z] [2026-02-12T16:53:56.138Z] TEST SETUP: [2026-02-12T16:53:56.138Z] Nothing to be done for setup. [2026-02-12T16:53:56.138Z] [2026-02-12T16:53:56.138Z] TESTING: [2026-02-12T16:54:03.658Z] NOTE: 'als' benchmark uses Spark local executor with 4 (out of 4) threads. [2026-02-12T16:54:09.805Z] ====== als (apache-spark) [default], iteration 0 started ====== [2026-02-12T16:54:09.805Z] GC before operation: completed in 55.609 ms, heap usage 226.992 MB -> 35.182 MB. [2026-02-12T16:54:33.685Z] ====== als (apache-spark) [default], iteration 0 completed (23090.156 ms) ====== [2026-02-12T16:54:33.685Z] ====== als (apache-spark) [default], iteration 1 started ====== [2026-02-12T16:54:33.685Z] GC before operation: completed in 97.122 ms, heap usage 219.391 MB -> 62.125 MB. [2026-02-12T16:54:45.188Z] ====== als (apache-spark) [default], iteration 1 completed (9939.620 ms) ====== [2026-02-12T16:54:45.188Z] ====== als (apache-spark) [default], iteration 2 started ====== [2026-02-12T16:54:45.188Z] GC before operation: completed in 86.763 ms, heap usage 219.447 MB -> 63.072 MB. [2026-02-12T16:54:52.876Z] ====== als (apache-spark) [default], iteration 2 completed (8949.777 ms) ====== [2026-02-12T16:54:52.876Z] ====== als (apache-spark) [default], iteration 3 started ====== [2026-02-12T16:54:53.229Z] GC before operation: completed in 91.111 ms, heap usage 323.515 MB -> 63.719 MB. [2026-02-12T16:55:02.735Z] ====== als (apache-spark) [default], iteration 3 completed (9074.928 ms) ====== [2026-02-12T16:55:02.735Z] ====== als (apache-spark) [default], iteration 4 started ====== [2026-02-12T16:55:02.735Z] GC before operation: completed in 92.089 ms, heap usage 432.236 MB -> 64.606 MB. [2026-02-12T16:55:12.146Z] ====== als (apache-spark) [default], iteration 4 completed (8728.036 ms) ====== [2026-02-12T16:55:12.146Z] ====== als (apache-spark) [default], iteration 5 started ====== [2026-02-12T16:55:12.146Z] GC before operation: completed in 95.907 ms, heap usage 186.294 MB -> 64.640 MB. [2026-02-12T16:55:21.496Z] ====== als (apache-spark) [default], iteration 5 completed (8705.582 ms) ====== [2026-02-12T16:55:21.496Z] ====== als (apache-spark) [default], iteration 6 started ====== [2026-02-12T16:55:21.496Z] GC before operation: completed in 114.454 ms, heap usage 534.436 MB -> 65.765 MB. [2026-02-12T16:55:30.956Z] ====== als (apache-spark) [default], iteration 6 completed (8583.730 ms) ====== [2026-02-12T16:55:30.956Z] ====== als (apache-spark) [default], iteration 7 started ====== [2026-02-12T16:55:30.956Z] GC before operation: completed in 99.590 ms, heap usage 365.450 MB -> 66.042 MB. [2026-02-12T16:55:40.288Z] ====== als (apache-spark) [default], iteration 7 completed (8675.597 ms) ====== [2026-02-12T16:55:40.288Z] ====== als (apache-spark) [default], iteration 8 started ====== [2026-02-12T16:55:40.288Z] GC before operation: completed in 103.582 ms, heap usage 360.034 MB -> 66.534 MB. [2026-02-12T16:55:48.076Z] ====== als (apache-spark) [default], iteration 8 completed (8628.573 ms) ====== [2026-02-12T16:55:48.076Z] ====== als (apache-spark) [default], iteration 9 started ====== [2026-02-12T16:55:48.076Z] GC before operation: completed in 116.159 ms, heap usage 386.221 MB -> 67.115 MB. [2026-02-12T16:55:59.199Z] ====== als (apache-spark) [default], iteration 9 completed (8454.544 ms) ====== [2026-02-12T16:55:59.199Z] ====== als (apache-spark) [default], iteration 10 started ====== [2026-02-12T16:55:59.199Z] GC before operation: completed in 118.246 ms, heap usage 189.800 MB -> 67.003 MB. [2026-02-12T16:56:05.512Z] ====== als (apache-spark) [default], iteration 10 completed (8445.348 ms) ====== [2026-02-12T16:56:05.512Z] ====== als (apache-spark) [default], iteration 11 started ====== [2026-02-12T16:56:05.867Z] GC before operation: completed in 103.100 ms, heap usage 97.350 MB -> 67.814 MB. [2026-02-12T16:56:15.188Z] ====== als (apache-spark) [default], iteration 11 completed (8385.439 ms) ====== [2026-02-12T16:56:15.188Z] ====== als (apache-spark) [default], iteration 12 started ====== [2026-02-12T16:56:15.188Z] GC before operation: completed in 109.679 ms, heap usage 204.364 MB -> 67.465 MB. [2026-02-12T16:56:24.633Z] ====== als (apache-spark) [default], iteration 12 completed (8494.675 ms) ====== [2026-02-12T16:56:24.633Z] ====== als (apache-spark) [default], iteration 13 started ====== [2026-02-12T16:56:24.633Z] GC before operation: completed in 109.077 ms, heap usage 331.324 MB -> 67.977 MB. [2026-02-12T16:56:32.437Z] ====== als (apache-spark) [default], iteration 13 completed (8274.354 ms) ====== [2026-02-12T16:56:32.437Z] ====== als (apache-spark) [default], iteration 14 started ====== [2026-02-12T16:56:32.437Z] GC before operation: completed in 119.736 ms, heap usage 506.221 MB -> 68.525 MB. [2026-02-12T16:56:41.764Z] ====== als (apache-spark) [default], iteration 14 completed (8329.629 ms) ====== [2026-02-12T16:56:41.764Z] ====== als (apache-spark) [default], iteration 15 started ====== [2026-02-12T16:56:41.764Z] GC before operation: completed in 109.117 ms, heap usage 200.579 MB -> 68.329 MB. [2026-02-12T16:56:49.580Z] ====== als (apache-spark) [default], iteration 15 completed (8337.286 ms) ====== [2026-02-12T16:56:49.580Z] ====== als (apache-spark) [default], iteration 16 started ====== [2026-02-12T16:56:49.580Z] GC before operation: completed in 109.950 ms, heap usage 122.477 MB -> 68.621 MB. [2026-02-12T16:56:59.079Z] ====== als (apache-spark) [default], iteration 16 completed (8424.296 ms) ====== [2026-02-12T16:56:59.079Z] ====== als (apache-spark) [default], iteration 17 started ====== [2026-02-12T16:56:59.079Z] GC before operation: completed in 117.258 ms, heap usage 503.191 MB -> 69.224 MB. [2026-02-12T16:57:06.807Z] ====== als (apache-spark) [default], iteration 17 completed (8332.752 ms) ====== [2026-02-12T16:57:06.807Z] ====== als (apache-spark) [default], iteration 18 started ====== [2026-02-12T16:57:06.807Z] GC before operation: completed in 115.691 ms, heap usage 460.364 MB -> 69.526 MB. [2026-02-12T16:57:16.190Z] ====== als (apache-spark) [default], iteration 18 completed (8316.714 ms) ====== [2026-02-12T16:57:16.190Z] ====== als (apache-spark) [default], iteration 19 started ====== [2026-02-12T16:57:16.190Z] GC before operation: completed in 110.356 ms, heap usage 136.525 MB -> 69.316 MB. [2026-02-12T16:57:24.057Z] ====== als (apache-spark) [default], iteration 19 completed (8304.736 ms) ====== [2026-02-12T16:57:24.057Z] ====== als (apache-spark) [default], iteration 20 started ====== [2026-02-12T16:57:24.436Z] GC before operation: completed in 110.836 ms, heap usage 493.684 MB -> 70.081 MB. [2026-02-12T16:57:33.860Z] ====== als (apache-spark) [default], iteration 20 completed (8803.435 ms) ====== [2026-02-12T16:57:33.860Z] ====== als (apache-spark) [default], iteration 21 started ====== [2026-02-12T16:57:33.860Z] GC before operation: completed in 113.289 ms, heap usage 160.087 MB -> 69.893 MB. [2026-02-12T16:57:43.252Z] ====== als (apache-spark) [default], iteration 21 completed (8376.967 ms) ====== [2026-02-12T16:57:43.252Z] ====== als (apache-spark) [default], iteration 22 started ====== [2026-02-12T16:57:43.252Z] GC before operation: completed in 115.131 ms, heap usage 460.408 MB -> 70.570 MB. [2026-02-12T16:57:51.026Z] ====== als (apache-spark) [default], iteration 22 completed (8244.703 ms) ====== [2026-02-12T16:57:51.026Z] ====== als (apache-spark) [default], iteration 23 started ====== [2026-02-12T16:57:51.026Z] GC before operation: completed in 112.660 ms, heap usage 293.548 MB -> 70.579 MB. [2026-02-12T16:58:00.478Z] ====== als (apache-spark) [default], iteration 23 completed (8173.472 ms) ====== [2026-02-12T16:58:00.478Z] ====== als (apache-spark) [default], iteration 24 started ====== [2026-02-12T16:58:00.478Z] GC before operation: completed in 116.018 ms, heap usage 460.076 MB -> 71.160 MB. [2026-02-12T16:58:08.127Z] ====== als (apache-spark) [default], iteration 24 completed (8345.497 ms) ====== [2026-02-12T16:58:08.127Z] ====== als (apache-spark) [default], iteration 25 started ====== [2026-02-12T16:58:08.127Z] GC before operation: completed in 115.837 ms, heap usage 397.489 MB -> 71.226 MB. [2026-02-12T16:58:17.562Z] ====== als (apache-spark) [default], iteration 25 completed (8364.400 ms) ====== [2026-02-12T16:58:17.562Z] ====== als (apache-spark) [default], iteration 26 started ====== [2026-02-12T16:58:17.562Z] GC before operation: completed in 117.833 ms, heap usage 468.773 MB -> 71.686 MB. [2026-02-12T16:58:25.266Z] ====== als (apache-spark) [default], iteration 26 completed (8052.308 ms) ====== [2026-02-12T16:58:25.266Z] ====== als (apache-spark) [default], iteration 27 started ====== [2026-02-12T16:58:25.266Z] GC before operation: completed in 118.957 ms, heap usage 275.348 MB -> 71.768 MB. [2026-02-12T16:58:34.544Z] ====== als (apache-spark) [default], iteration 27 completed (8231.939 ms) ====== [2026-02-12T16:58:34.544Z] ====== als (apache-spark) [default], iteration 28 started ====== [2026-02-12T16:58:34.544Z] GC before operation: completed in 116.199 ms, heap usage 216.281 MB -> 71.774 MB. [2026-02-12T16:58:42.442Z] ====== als (apache-spark) [default], iteration 28 completed (8147.426 ms) ====== [2026-02-12T16:58:42.442Z] ====== als (apache-spark) [default], iteration 29 started ====== [2026-02-12T16:58:42.442Z] GC before operation: completed in 116.671 ms, heap usage 207.033 MB -> 72.096 MB. [2026-02-12T16:58:51.826Z] ====== als (apache-spark) [default], iteration 29 completed (8235.404 ms) ====== [2026-02-12T16:58:51.826Z] ----------------------------------- [2026-02-12T16:58:51.826Z] renaissance-als_0_PASSED [2026-02-12T16:58:51.826Z] ----------------------------------- [2026-02-12T16:58:51.826Z] [2026-02-12T16:58:51.826Z] TEST TEARDOWN: [2026-02-12T16:58:51.826Z] Nothing to be done for teardown. [2026-02-12T16:58:51.826Z] renaissance-als_0 Finish Time: Thu Feb 12 16:58:51 2026 Epoch Time (ms): 1770915531038