[2025-03-26T22:11:28.504Z] Running test renaissance-scala-kmeans_0 ... [2025-03-26T22:11:28.504Z] =============================================== [2025-03-26T22:11:28.504Z] renaissance-scala-kmeans_0 Start Time: Wed Mar 26 22:11:28 2025 Epoch Time (ms): 1743027088294 [2025-03-26T22:11:28.504Z] variation: NoOptions [2025-03-26T22:11:28.504Z] JVM_OPTIONS: [2025-03-26T22:11:28.504Z] { \ [2025-03-26T22:11:28.504Z] echo ""; echo "TEST SETUP:"; \ [2025-03-26T22:11:28.504Z] echo "Nothing to be done for setup."; \ [2025-03-26T22:11:28.504Z] mkdir -p "/home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17430265274881/renaissance-scala-kmeans_0"; \ [2025-03-26T22:11:28.504Z] cd "/home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17430265274881/renaissance-scala-kmeans_0"; \ [2025-03-26T22:11:28.504Z] echo ""; echo "TESTING:"; \ [2025-03-26T22:11:28.504Z] /home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../perf/run_with_affinity.sh --exec_cmd ""/home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/jdkbinary/j2sdk-image/bin/java" -jar "/home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar" --json ""/home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17430265274881/renaissance-scala-kmeans_0"/scala-kmeans.json" scala-kmeans" --test_root /home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/..; \ [2025-03-26T22:11:28.504Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "renaissance-scala-kmeans_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17430265274881/renaissance-scala-kmeans_0"; else echo "-----------------------------------"; echo "renaissance-scala-kmeans_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-03-26T22:11:28.504Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-03-26T22:11:28.504Z] echo "Nothing to be done for teardown."; \ [2025-03-26T22:11:28.504Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17430265274881/TestTargetResult"; [2025-03-26T22:11:28.504Z] [2025-03-26T22:11:28.504Z] TEST SETUP: [2025-03-26T22:11:28.504Z] Nothing to be done for setup. [2025-03-26T22:11:28.504Z] [2025-03-26T22:11:28.504Z] TESTING: [2025-03-26T22:11:29.453Z] Warning!!! Affinity is NOT set. Affinity tool may NOT be installed/supported. [2025-03-26T22:11:29.453Z] Running EXEC_CMD_WITH_AFFINITY= /home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/jdkbinary/j2sdk-image/bin/java -jar /home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../../jvmtest/perf/renaissance/renaissance.jar --json /home/jenkins/workspace/Test_openjdk21_hs_sanity.perf_ppc64le_linux/aqa-tests/TKG/../TKG/output_17430265274881/renaissance-scala-kmeans_0/scala-kmeans.json scala-kmeans [2025-03-26T22:11:30.403Z] ====== scala-kmeans (scala) [default], iteration 0 started ====== [2025-03-26T22:11:30.403Z] GC before operation: completed in 48.676 ms, heap usage 32.315 MB -> 26.034 MB. [2025-03-26T22:11:30.403Z] ====== scala-kmeans (scala) [default], iteration 0 completed (551.877 ms) ====== [2025-03-26T22:11:30.403Z] ====== scala-kmeans (scala) [default], iteration 1 started ====== [2025-03-26T22:11:30.403Z] GC before operation: completed in 58.308 ms, heap usage 67.114 MB -> 26.271 MB. [2025-03-26T22:11:31.352Z] ====== scala-kmeans (scala) [default], iteration 1 completed (428.026 ms) ====== [2025-03-26T22:11:31.352Z] ====== scala-kmeans (scala) [default], iteration 2 started ====== [2025-03-26T22:11:31.352Z] GC before operation: completed in 43.952 ms, heap usage 48.350 MB -> 26.127 MB. [2025-03-26T22:11:31.352Z] ====== scala-kmeans (scala) [default], iteration 2 completed (431.364 ms) ====== [2025-03-26T22:11:31.352Z] ====== scala-kmeans (scala) [default], iteration 3 started ====== [2025-03-26T22:11:31.352Z] GC before operation: completed in 27.498 ms, heap usage 42.190 MB -> 26.127 MB. [2025-03-26T22:11:32.302Z] ====== scala-kmeans (scala) [default], iteration 3 completed (448.323 ms) ====== [2025-03-26T22:11:32.302Z] ====== scala-kmeans (scala) [default], iteration 4 started ====== [2025-03-26T22:11:32.302Z] GC before operation: completed in 45.439 ms, heap usage 42.600 MB -> 26.128 MB. [2025-03-26T22:11:32.302Z] ====== scala-kmeans (scala) [default], iteration 4 completed (440.279 ms) ====== [2025-03-26T22:11:32.302Z] ====== scala-kmeans (scala) [default], iteration 5 started ====== [2025-03-26T22:11:33.253Z] GC before operation: completed in 45.086 ms, heap usage 42.340 MB -> 26.128 MB. [2025-03-26T22:11:33.253Z] ====== scala-kmeans (scala) [default], iteration 5 completed (435.886 ms) ====== [2025-03-26T22:11:33.253Z] ====== scala-kmeans (scala) [default], iteration 6 started ====== [2025-03-26T22:11:33.253Z] GC before operation: completed in 44.293 ms, heap usage 42.340 MB -> 26.128 MB. [2025-03-26T22:11:33.253Z] ====== scala-kmeans (scala) [default], iteration 6 completed (444.544 ms) ====== [2025-03-26T22:11:33.253Z] ====== scala-kmeans (scala) [default], iteration 7 started ====== [2025-03-26T22:11:34.201Z] GC before operation: completed in 25.225 ms, heap usage 94.540 MB -> 26.128 MB. [2025-03-26T22:11:34.201Z] ====== scala-kmeans (scala) [default], iteration 7 completed (432.219 ms) ====== [2025-03-26T22:11:34.201Z] ====== scala-kmeans (scala) [default], iteration 8 started ====== [2025-03-26T22:11:34.201Z] GC before operation: completed in 44.336 ms, heap usage 42.179 MB -> 26.128 MB. [2025-03-26T22:11:34.201Z] ====== scala-kmeans (scala) [default], iteration 8 completed (429.901 ms) ====== [2025-03-26T22:11:34.201Z] ====== scala-kmeans (scala) [default], iteration 9 started ====== [2025-03-26T22:11:35.151Z] GC before operation: completed in 43.942 ms, heap usage 42.335 MB -> 26.128 MB. [2025-03-26T22:11:35.151Z] ====== scala-kmeans (scala) [default], iteration 9 completed (427.418 ms) ====== [2025-03-26T22:11:35.151Z] ====== scala-kmeans (scala) [default], iteration 10 started ====== [2025-03-26T22:11:35.151Z] GC before operation: completed in 48.374 ms, heap usage 42.340 MB -> 26.128 MB. [2025-03-26T22:11:35.151Z] ====== scala-kmeans (scala) [default], iteration 10 completed (434.692 ms) ====== [2025-03-26T22:11:35.151Z] ====== scala-kmeans (scala) [default], iteration 11 started ====== [2025-03-26T22:11:36.100Z] GC before operation: completed in 25.265 ms, heap usage 94.410 MB -> 26.128 MB. [2025-03-26T22:11:36.100Z] ====== scala-kmeans (scala) [default], iteration 11 completed (425.087 ms) ====== [2025-03-26T22:11:36.100Z] ====== scala-kmeans (scala) [default], iteration 12 started ====== [2025-03-26T22:11:36.100Z] GC before operation: completed in 44.685 ms, heap usage 42.399 MB -> 26.129 MB. [2025-03-26T22:11:36.100Z] ====== scala-kmeans (scala) [default], iteration 12 completed (425.961 ms) ====== [2025-03-26T22:11:36.100Z] ====== scala-kmeans (scala) [default], iteration 13 started ====== [2025-03-26T22:11:37.048Z] GC before operation: completed in 54.516 ms, heap usage 42.336 MB -> 26.129 MB. [2025-03-26T22:11:37.048Z] ====== scala-kmeans (scala) [default], iteration 13 completed (424.859 ms) ====== [2025-03-26T22:11:37.048Z] ====== scala-kmeans (scala) [default], iteration 14 started ====== [2025-03-26T22:11:37.048Z] GC before operation: completed in 44.594 ms, heap usage 42.163 MB -> 26.129 MB. [2025-03-26T22:11:37.048Z] ====== scala-kmeans (scala) [default], iteration 14 completed (430.626 ms) ====== [2025-03-26T22:11:37.048Z] ====== scala-kmeans (scala) [default], iteration 15 started ====== [2025-03-26T22:11:37.048Z] GC before operation: completed in 24.230 ms, heap usage 94.411 MB -> 26.129 MB. [2025-03-26T22:11:37.996Z] ====== scala-kmeans (scala) [default], iteration 15 completed (426.929 ms) ====== [2025-03-26T22:11:37.996Z] ====== scala-kmeans (scala) [default], iteration 16 started ====== [2025-03-26T22:11:37.996Z] GC before operation: completed in 43.891 ms, heap usage 42.338 MB -> 26.129 MB. [2025-03-26T22:11:37.996Z] ====== scala-kmeans (scala) [default], iteration 16 completed (421.344 ms) ====== [2025-03-26T22:11:37.996Z] ====== scala-kmeans (scala) [default], iteration 17 started ====== [2025-03-26T22:11:37.996Z] GC before operation: completed in 44.148 ms, heap usage 42.160 MB -> 26.129 MB. [2025-03-26T22:11:38.946Z] ====== scala-kmeans (scala) [default], iteration 17 completed (421.948 ms) ====== [2025-03-26T22:11:38.946Z] ====== scala-kmeans (scala) [default], iteration 18 started ====== [2025-03-26T22:11:38.946Z] GC before operation: completed in 65.123 ms, heap usage 42.163 MB -> 26.129 MB. [2025-03-26T22:11:38.946Z] ====== scala-kmeans (scala) [default], iteration 18 completed (429.184 ms) ====== [2025-03-26T22:11:38.946Z] ====== scala-kmeans (scala) [default], iteration 19 started ====== [2025-03-26T22:11:38.946Z] GC before operation: completed in 28.330 ms, heap usage 94.541 MB -> 26.129 MB. [2025-03-26T22:11:39.895Z] ====== scala-kmeans (scala) [default], iteration 19 completed (420.778 ms) ====== [2025-03-26T22:11:39.895Z] ====== scala-kmeans (scala) [default], iteration 20 started ====== [2025-03-26T22:11:39.895Z] GC before operation: completed in 43.294 ms, heap usage 42.338 MB -> 26.129 MB. [2025-03-26T22:11:39.895Z] ====== scala-kmeans (scala) [default], iteration 20 completed (420.146 ms) ====== [2025-03-26T22:11:39.895Z] ====== scala-kmeans (scala) [default], iteration 21 started ====== [2025-03-26T22:11:39.895Z] GC before operation: completed in 43.533 ms, heap usage 42.337 MB -> 26.129 MB. [2025-03-26T22:11:40.845Z] ====== scala-kmeans (scala) [default], iteration 21 completed (418.056 ms) ====== [2025-03-26T22:11:40.845Z] ====== scala-kmeans (scala) [default], iteration 22 started ====== [2025-03-26T22:11:40.845Z] GC before operation: completed in 43.805 ms, heap usage 42.342 MB -> 26.129 MB. [2025-03-26T22:11:40.845Z] ====== scala-kmeans (scala) [default], iteration 22 completed (424.843 ms) ====== [2025-03-26T22:11:40.845Z] ====== scala-kmeans (scala) [default], iteration 23 started ====== [2025-03-26T22:11:40.845Z] GC before operation: completed in 27.801 ms, heap usage 94.541 MB -> 26.129 MB. [2025-03-26T22:11:41.794Z] ====== scala-kmeans (scala) [default], iteration 23 completed (433.147 ms) ====== [2025-03-26T22:11:41.794Z] ====== scala-kmeans (scala) [default], iteration 24 started ====== [2025-03-26T22:11:41.794Z] GC before operation: completed in 43.260 ms, heap usage 42.181 MB -> 26.130 MB. [2025-03-26T22:11:41.794Z] ====== scala-kmeans (scala) [default], iteration 24 completed (429.021 ms) ====== [2025-03-26T22:11:41.795Z] ====== scala-kmeans (scala) [default], iteration 25 started ====== [2025-03-26T22:11:41.795Z] GC before operation: completed in 43.806 ms, heap usage 42.337 MB -> 26.130 MB. [2025-03-26T22:11:42.743Z] ====== scala-kmeans (scala) [default], iteration 25 completed (431.618 ms) ====== [2025-03-26T22:11:42.743Z] ====== scala-kmeans (scala) [default], iteration 26 started ====== [2025-03-26T22:11:42.743Z] GC before operation: completed in 50.673 ms, heap usage 42.164 MB -> 26.130 MB. [2025-03-26T22:11:42.743Z] ====== scala-kmeans (scala) [default], iteration 26 completed (441.786 ms) ====== [2025-03-26T22:11:42.743Z] ====== scala-kmeans (scala) [default], iteration 27 started ====== [2025-03-26T22:11:42.743Z] GC before operation: completed in 28.517 ms, heap usage 94.411 MB -> 26.130 MB. [2025-03-26T22:11:43.692Z] ====== scala-kmeans (scala) [default], iteration 27 completed (430.991 ms) ====== [2025-03-26T22:11:43.692Z] ====== scala-kmeans (scala) [default], iteration 28 started ====== [2025-03-26T22:11:43.692Z] GC before operation: completed in 43.476 ms, heap usage 42.181 MB -> 26.130 MB. [2025-03-26T22:11:43.692Z] ====== scala-kmeans (scala) [default], iteration 28 completed (428.669 ms) ====== [2025-03-26T22:11:43.692Z] ====== scala-kmeans (scala) [default], iteration 29 started ====== [2025-03-26T22:11:43.692Z] GC before operation: completed in 43.119 ms, heap usage 42.160 MB -> 26.130 MB. [2025-03-26T22:11:44.640Z] ====== scala-kmeans (scala) [default], iteration 29 completed (428.594 ms) ====== [2025-03-26T22:11:44.640Z] ====== scala-kmeans (scala) [default], iteration 30 started ====== [2025-03-26T22:11:44.641Z] GC before operation: completed in 44.923 ms, heap usage 42.342 MB -> 26.130 MB. [2025-03-26T22:11:44.641Z] ====== scala-kmeans (scala) [default], iteration 30 completed (433.270 ms) ====== [2025-03-26T22:11:44.641Z] ====== scala-kmeans (scala) [default], iteration 31 started ====== [2025-03-26T22:11:44.641Z] GC before operation: completed in 36.813 ms, heap usage 94.412 MB -> 26.130 MB. [2025-03-26T22:11:45.595Z] ====== scala-kmeans (scala) [default], iteration 31 completed (427.739 ms) ====== [2025-03-26T22:11:45.595Z] ====== scala-kmeans (scala) [default], iteration 32 started ====== [2025-03-26T22:11:45.595Z] GC before operation: completed in 44.069 ms, heap usage 42.181 MB -> 26.130 MB. [2025-03-26T22:11:45.595Z] ====== scala-kmeans (scala) [default], iteration 32 completed (426.895 ms) ====== [2025-03-26T22:11:45.595Z] ====== scala-kmeans (scala) [default], iteration 33 started ====== [2025-03-26T22:11:45.595Z] GC before operation: completed in 43.506 ms, heap usage 42.338 MB -> 26.130 MB. [2025-03-26T22:11:46.543Z] ====== scala-kmeans (scala) [default], iteration 33 completed (427.347 ms) ====== [2025-03-26T22:11:46.543Z] ====== scala-kmeans (scala) [default], iteration 34 started ====== [2025-03-26T22:11:46.543Z] GC before operation: completed in 43.886 ms, heap usage 42.343 MB -> 26.131 MB. [2025-03-26T22:11:46.543Z] ====== scala-kmeans (scala) [default], iteration 34 completed (435.275 ms) ====== [2025-03-26T22:11:46.543Z] ====== scala-kmeans (scala) [default], iteration 35 started ====== [2025-03-26T22:11:46.543Z] GC before operation: completed in 24.926 ms, heap usage 94.543 MB -> 26.131 MB. [2025-03-26T22:11:47.492Z] ====== scala-kmeans (scala) [default], iteration 35 completed (424.884 ms) ====== [2025-03-26T22:11:47.492Z] ====== scala-kmeans (scala) [default], iteration 36 started ====== [2025-03-26T22:11:47.492Z] GC before operation: completed in 43.030 ms, heap usage 42.340 MB -> 26.133 MB. [2025-03-26T22:11:47.492Z] ====== scala-kmeans (scala) [default], iteration 36 completed (427.388 ms) ====== [2025-03-26T22:11:47.492Z] ====== scala-kmeans (scala) [default], iteration 37 started ====== [2025-03-26T22:11:47.492Z] GC before operation: completed in 43.527 ms, heap usage 42.340 MB -> 26.132 MB. [2025-03-26T22:11:48.441Z] ====== scala-kmeans (scala) [default], iteration 37 completed (424.899 ms) ====== [2025-03-26T22:11:48.441Z] ====== scala-kmeans (scala) [default], iteration 38 started ====== [2025-03-26T22:11:48.441Z] GC before operation: completed in 44.058 ms, heap usage 42.345 MB -> 26.133 MB. [2025-03-26T22:11:48.441Z] ====== scala-kmeans (scala) [default], iteration 38 completed (432.044 ms) ====== [2025-03-26T22:11:48.441Z] ====== scala-kmeans (scala) [default], iteration 39 started ====== [2025-03-26T22:11:48.441Z] GC before operation: completed in 24.526 ms, heap usage 94.544 MB -> 26.133 MB. [2025-03-26T22:11:49.389Z] ====== scala-kmeans (scala) [default], iteration 39 completed (423.960 ms) ====== [2025-03-26T22:11:49.389Z] ====== scala-kmeans (scala) [default], iteration 40 started ====== [2025-03-26T22:11:49.390Z] GC before operation: completed in 46.051 ms, heap usage 42.184 MB -> 26.133 MB. [2025-03-26T22:11:49.390Z] ====== scala-kmeans (scala) [default], iteration 40 completed (422.724 ms) ====== [2025-03-26T22:11:49.390Z] ====== scala-kmeans (scala) [default], iteration 41 started ====== [2025-03-26T22:11:49.390Z] GC before operation: completed in 46.259 ms, heap usage 42.340 MB -> 26.133 MB. [2025-03-26T22:11:50.339Z] ====== scala-kmeans (scala) [default], iteration 41 completed (422.866 ms) ====== [2025-03-26T22:11:50.339Z] ====== scala-kmeans (scala) [default], iteration 42 started ====== [2025-03-26T22:11:50.339Z] GC before operation: completed in 42.775 ms, heap usage 42.345 MB -> 26.133 MB. [2025-03-26T22:11:50.339Z] ====== scala-kmeans (scala) [default], iteration 42 completed (429.160 ms) ====== [2025-03-26T22:11:50.339Z] ====== scala-kmeans (scala) [default], iteration 43 started ====== [2025-03-26T22:11:50.339Z] GC before operation: completed in 29.087 ms, heap usage 94.545 MB -> 26.133 MB. [2025-03-26T22:11:51.287Z] ====== scala-kmeans (scala) [default], iteration 43 completed (426.346 ms) ====== [2025-03-26T22:11:51.287Z] ====== scala-kmeans (scala) [default], iteration 44 started ====== [2025-03-26T22:11:51.287Z] GC before operation: completed in 43.238 ms, heap usage 42.184 MB -> 26.133 MB. [2025-03-26T22:11:51.287Z] ====== scala-kmeans (scala) [default], iteration 44 completed (422.497 ms) ====== [2025-03-26T22:11:51.287Z] ====== scala-kmeans (scala) [default], iteration 45 started ====== [2025-03-26T22:11:51.287Z] GC before operation: completed in 44.437 ms, heap usage 42.340 MB -> 26.133 MB. [2025-03-26T22:11:52.236Z] ====== scala-kmeans (scala) [default], iteration 45 completed (431.128 ms) ====== [2025-03-26T22:11:52.236Z] ====== scala-kmeans (scala) [default], iteration 46 started ====== [2025-03-26T22:11:52.236Z] GC before operation: completed in 24.055 ms, heap usage 42.345 MB -> 26.133 MB. [2025-03-26T22:11:52.236Z] ====== scala-kmeans (scala) [default], iteration 46 completed (423.491 ms) ====== [2025-03-26T22:11:52.236Z] ====== scala-kmeans (scala) [default], iteration 47 started ====== [2025-03-26T22:11:52.236Z] GC before operation: completed in 43.597 ms, heap usage 42.346 MB -> 26.133 MB. [2025-03-26T22:11:53.184Z] ====== scala-kmeans (scala) [default], iteration 47 completed (432.773 ms) ====== [2025-03-26T22:11:53.184Z] ====== scala-kmeans (scala) [default], iteration 48 started ====== [2025-03-26T22:11:53.184Z] GC before operation: completed in 44.273 ms, heap usage 42.346 MB -> 26.133 MB. [2025-03-26T22:11:53.184Z] ====== scala-kmeans (scala) [default], iteration 48 completed (433.720 ms) ====== [2025-03-26T22:11:53.184Z] ====== scala-kmeans (scala) [default], iteration 49 started ====== [2025-03-26T22:11:53.184Z] GC before operation: completed in 44.613 ms, heap usage 42.167 MB -> 26.133 MB. [2025-03-26T22:11:54.880Z] ====== scala-kmeans (scala) [default], iteration 49 completed (443.005 ms) ====== [2025-03-26T22:11:54.880Z] ----------------------------------- [2025-03-26T22:11:54.880Z] renaissance-scala-kmeans_0_PASSED [2025-03-26T22:11:54.880Z] ----------------------------------- [2025-03-26T22:11:54.880Z] [2025-03-26T22:11:54.880Z] TEST TEARDOWN: [2025-03-26T22:11:54.880Z] Nothing to be done for teardown. [2025-03-26T22:11:54.880Z] renaissance-scala-kmeans_0 Finish Time: Wed Mar 26 22:11:53 2025 Epoch Time (ms): 1743027113561