TestJlmRemoteThreadNoAuth_0
[2024-08-30T22:18:57.231Z] Running test TestJlmRemoteThreadNoAuth_0 ...
[2024-08-30T22:18:57.231Z] ===============================================
[2024-08-30T22:18:57.231Z] TestJlmRemoteThreadNoAuth_0 Start Time: Fri Aug 30 22:18:56 2024 Epoch Time (ms): 1725056336724
[2024-08-30T22:18:57.231Z] variation: Mode150
[2024-08-30T22:18:57.231Z] JVM_OPTIONS: -XX:+UseCompressedOops
[2024-08-30T22:18:57.231Z] { \
[2024-08-30T22:18:57.231Z] echo ""; echo "TEST SETUP:"; \
[2024-08-30T22:18:57.231Z] echo "Nothing to be done for setup."; \
[2024-08-30T22:18:57.231Z] mkdir -p "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0"; \
[2024-08-30T22:18:57.231Z] cd "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0"; \
[2024-08-30T22:18:57.231Z] echo ""; echo "TESTING:"; \
[2024-08-30T22:18:57.231Z] perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../../jvmtest/system/jlm/..//STF/stf.core/scripts/stf.pl -test-root="/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../../jvmtest/system/jlm/..//STF;/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../../jvmtest/system/jlm/..//aqa-systemtest""" -systemtest-prereqs="/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/../../testDependency/system_lib/" -java-args=' -XX:+UseCompressedOops ' -results-root="/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0" -test=TestJlmRemoteThreadNoAuth; \
[2024-08-30T22:18:57.231Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_0""_PASSED"; echo "-----------------------------------"; cd /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/..; rm -f -r "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0"; else echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_0""_FAILED"; echo "-----------------------------------"; fi; \
[2024-08-30T22:18:57.231Z] echo ""; echo "TEST TEARDOWN:"; \
[2024-08-30T22:18:57.231Z] echo "Nothing to be done for teardown."; \
[2024-08-30T22:18:57.232Z] } 2>&1 | tee -a "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestTargetResult";
[2024-08-30T22:18:57.232Z]
[2024-08-30T22:18:57.232Z] TEST SETUP:
[2024-08-30T22:18:57.232Z] Nothing to be done for setup.
[2024-08-30T22:18:57.232Z]
[2024-08-30T22:18:57.232Z] TESTING:
[2024-08-30T22:18:57.232Z] STF 22:18:57.016 - ========================= S T F =========================
[2024-08-30T22:18:57.232Z] systemtest-prereqs has been processed, and set to: /home/jenkins/testDependency/system_libRetrieving amount of free space on drive containing /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0
[2024-08-30T22:18:57.232Z] There is 238753 Mb free
[2024-08-30T22:18:57.232Z] STF 22:18:57.034 - ================== G E N E R A T I O N ==================
[2024-08-30T22:18:57.232Z] STF 22:18:57.035 - Checking JVM: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image
[2024-08-30T22:18:57.232Z] STF 22:18:57.035 - Starting process to generate scripts: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java -Dlog4j.skipJansi=true -Djava.system.class.loader=net.adoptopenjdk.stf.runner.StfClassLoader -classpath /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/../../testDependency/system_lib//log4j/log4j-api.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/../../testDependency/system_lib//log4j/log4j-core.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/STF/stf.core/scripts/../bin net.adoptopenjdk.stf.runner.StfRunner -properties "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/stf_parameters.properties, , /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/STF/stf.core/config/stf.properties" -testDir "/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth"
[2024-08-30T22:18:57.232Z] GEN stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2024-08-30T22:18:58.000Z] GEN [0.052s][warning][cds] Archived non-system classes are disabled because the java.system.class.loader property is specified (value = "net.adoptopenjdk.stf.runner.StfClassLoader"). To use archived non-system classes, this property must not be set
[2024-08-30T22:19:02.400Z] GEN 22:19:01.962 - Found test. Project: 'openjdk.test.jlm' class: 'TestJlmRemoteThreadNoAuth.class' Dir: '/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.jlm/bin'
[2024-08-30T22:19:02.400Z] GEN 22:19:02.083 - Found test. Project: 'openjdk.test.jlm' class: 'net.adoptopenjdk.test.jlm.TestJlmRemoteThreadNoAuth'
[2024-08-30T22:19:03.177Z] GEN Classpath directories used by project 'openjdk.test.jlm':
[2024-08-30T22:19:03.177Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.jlm/bin
[2024-08-30T22:19:03.177Z] GEN /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/STF/stf.core/bin
[2024-08-30T22:19:03.177Z] GEN /home/jenkins/testDependency/system_lib/log4j/log4j-api.jar
[2024-08-30T22:19:03.177Z] GEN /home/jenkins/testDependency/system_lib/log4j/log4j-core.jar
[2024-08-30T22:19:03.177Z] GEN /home/jenkins/testDependency/system_lib/junit/junit.jar
[2024-08-30T22:19:03.177Z] GEN 22:19:02.873 - Using Mode NoOptions. Values = ''
[2024-08-30T22:19:03.934Z] GEN 22:19:03.479 -
[2024-08-30T22:19:03.934Z] GEN 22:19:03.487 - Test command summary:
[2024-08-30T22:19:03.934Z] GEN 22:19:03.488 - Step Stage Command Description
[2024-08-30T22:19:03.934Z] GEN 22:19:03.491 - -----+--------+-----------------+------------
[2024-08-30T22:19:03.934Z] GEN 22:19:03.491 - 1 execute Run java Running ThreadProfiler Proxy test Server Process
[2024-08-30T22:19:03.934Z] GEN 22:19:03.491 - 2 execute Run java Running the monitoring Client with proxy connection(without security)
[2024-08-30T22:19:03.934Z] GEN 22:19:03.491 - 3 execute Monitor Wait for processes to complete
[2024-08-30T22:19:03.934Z] GEN 22:19:03.491 - 4 execute kill Stop LT1 process
[2024-08-30T22:19:03.934Z] GEN 22:19:03.492 - 5 execute Run java Running ThreadProfiler Server test Server Process(without security)
[2024-08-30T22:19:03.934Z] GEN 22:19:03.492 - 6 execute Run java Running the Monitoring Client with server-connection(without security)
[2024-08-30T22:19:03.934Z] GEN 22:19:03.492 - 7 execute Monitor Wait for processes to complete
[2024-08-30T22:19:03.934Z] GEN 22:19:03.492 - 8 execute kill Stop LT2 process
[2024-08-30T22:19:03.934Z] STF 22:19:03.623 -
[2024-08-30T22:19:03.934Z] STF 22:19:03.623 - Script generation completed
[2024-08-30T22:19:03.934Z] STF 22:19:03.623 -
[2024-08-30T22:19:03.934Z] STF 22:19:03.623 -
[2024-08-30T22:19:03.934Z] STF 22:19:03.623 - ======================= S E T U P =======================
[2024-08-30T22:19:03.934Z] STF 22:19:03.623 - Running setup: perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/setUp.pl
[2024-08-30T22:19:03.934Z] STF 22:19:03.836 - SETUP stage completed
[2024-08-30T22:19:03.934Z] STF 22:19:03.845 -
[2024-08-30T22:19:03.934Z] STF 22:19:03.845 - ==================== E X E C U T E - ====================
[2024-08-30T22:19:03.934Z] STF 22:19:03.845 - Running execute: perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/execute.pl
[2024-08-30T22:19:04.737Z] STF 22:19:04.075 -
[2024-08-30T22:19:04.737Z] STF 22:19:04.075 - Java version
[2024-08-30T22:19:04.737Z] STF 22:19:04.075 - Running: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java -version
[2024-08-30T22:19:04.737Z] Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2024-08-30T22:19:04.737Z] openjdk version "21.0.5-beta" 2024-10-15
[2024-08-30T22:19:04.737Z] OpenJDK Runtime Environment Temurin-21.0.5+5-202408301904 (build 21.0.5-beta+5-ea)
[2024-08-30T22:19:04.737Z] OpenJDK 64-Bit Server VM Temurin-21.0.5+5-202408301904 (build 21.0.5-beta+5-ea, mixed mode, sharing)
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 -
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 - +------ Step 1 - Running ThreadProfiler Proxy test Server Process
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 - | Start background process
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 - | Program: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 - | Mnemonic: LT1
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 - | Echo: ECHO_OFF
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 - | Expectation: NEVER
[2024-08-30T22:19:04.737Z] STF 22:19:04.450 - |
[2024-08-30T22:19:04.738Z] STF 22:19:04.451 - Running command: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java -Xmx256m -Dcom.sun.management.jmxremote.port=1234 -Dcom.sun.management.jmxremote.authenticate=false -Dcom.sun.management.jmxremote.ssl=false -XX:+UseCompressedOops -classpath /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/STF/stf.load/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/STF/stf.core/bin:/home/jenkins/testDependency/system_lib/log4j/log4j-api.jar:/home/jenkins/testDependency/system_lib/log4j/log4j-core.jar:/home/jenkins/testDependency/system_lib/junit/junit.jar:/home/jenkins/testDependency/system_lib/junit/hamcrest-core.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.lang/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.util/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.math/bin net.adoptopenjdk.loadTest.LoadTest -resultsDir /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results -resultsPrefix 1.LT1. -timeLimit 30m -abortAtFailureLimit -1 -reportFailureLimit 1 -maxTotalLogFileSpace 200M -maxSingleLogSize 1/25 -suite.mini-mix.totalNumberTests 20000000 -suite.mini-mix.inventoryFile /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/util/util_exclude.xml -suite.mini-mix.threadCount 30 -suite.mini-mix.selection random -suite.mini-mix.seed -1 -suite.mini-mix.repeatCount 1 -suite.mini-mix.thinkingTime 0ms..0ms
[2024-08-30T22:19:04.738Z] STF 22:19:04.451 - Redirecting stderr to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/1.LT1.stderr
[2024-08-30T22:19:04.738Z] STF 22:19:04.451 - Redirecting stdout to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/1.LT1.stdout
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 -
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 - +------ Step 2 - Running the monitoring Client with proxy connection(without security)
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 - | Start background process
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 - | Program: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 - | Mnemonic: CL1
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 - | Echo: ECHO_ON
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 - | Expectation: CLEAN_RUN within 30m
[2024-08-30T22:19:04.738Z] STF 22:19:04.498 - |
[2024-08-30T22:19:04.738Z] STF 22:19:04.499 - Running command: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:+UseCompressedOops -classpath /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.jlm/bin:/home/jenkins/testDependency/system_lib/junit/junit.jar net.adoptopenjdk.test.jlm.remote.ThreadProfiler proxy /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/thd_proxy.log /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234
[2024-08-30T22:19:04.738Z] STF 22:19:04.499 - Redirecting stderr to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/2.CL1.stderr
[2024-08-30T22:19:04.738Z] STF 22:19:04.499 - Redirecting stdout to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/2.CL1.stdout
[2024-08-30T22:19:04.738Z] STF 22:19:04.510 -
[2024-08-30T22:19:04.738Z] STF 22:19:04.510 - +------ Step 3 - Wait for processes to complete
[2024-08-30T22:19:04.738Z] STF 22:19:04.510 - | Wait for processes to meet expectations
[2024-08-30T22:19:04.738Z] STF 22:19:04.510 - | Processes: [LT1, CL1]
[2024-08-30T22:19:04.738Z] STF 22:19:04.510 - |
[2024-08-30T22:19:04.738Z] STF 22:19:04.510 - Monitoring processes: CL1 LT1
[2024-08-30T22:19:04.738Z] CL1 stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2024-08-30T22:19:06.385Z] CL1 j> 2024/08/30 22:19:05.462 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi
[2024-08-30T22:19:06.385Z] CL1 j> 2024/08/30 22:19:06.015 Attempting to connect
[2024-08-30T22:19:07.161Z] CL1 j> 2024/08/30 22:19:06.892 Monitored VM not ready at Aug 30, 2024, 10:19:06 PM (attempt 1, elapsed 714ms).
[2024-08-30T22:19:07.161Z] CL1 j> 2024/08/30 22:19:06.893 Waiting 5 secs and trying again...
[2024-08-30T22:19:13.089Z] CL1 j> 2024/08/30 22:19:11.916 Attempting to connect
[2024-08-30T22:19:18.107Z] CL1 j> 2024/08/30 22:19:16.757 Connection established!
[2024-08-30T22:19:19.850Z] CL1 j> 2024/08/30 22:19:18.926 Starting to write data
[2024-08-30T22:24:19.249Z] STF 22:24:04.488 - Heartbeat: Process LT1 is still running
[2024-08-30T22:29:01.169Z] STF 22:28:54.573 - Monitoring Report Summary:
[2024-08-30T22:29:01.169Z] STF 22:28:54.573 - o Process CL1 ended with the expected exit code (0)
[2024-08-30T22:29:01.169Z] STF 22:28:54.573 - o Process LT1 is still running as expected
[2024-08-30T22:29:01.169Z] STF 22:28:54.573 -
[2024-08-30T22:29:01.170Z] STF 22:28:54.573 - +------ Step 4 - Stop LT1 process
[2024-08-30T22:29:01.170Z] STF 22:28:54.573 - | Kill running processes
[2024-08-30T22:29:01.170Z] STF 22:28:54.573 - | Processes: [LT1]
[2024-08-30T22:29:01.170Z] STF 22:28:54.573 - |
[2024-08-30T22:29:01.170Z] STF 22:28:54.600 - Killing processes: LT1
[2024-08-30T22:29:01.170Z] STF 22:28:54.601 - o Process clean up attempt 1 for LT1 pid 1385667
[2024-08-30T22:29:01.170Z] STF 22:28:54.601 - o Process LT1 pid 1385667 stop()
[2024-08-30T22:29:05.829Z] STF 22:29:04.696 - o Process LT1 pid 1385667 terminate()
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - o Process LT1 pid 1385667 killed
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 -
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - +------ Step 5 - Running ThreadProfiler Server test Server Process(without security)
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - | Start background process
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - | Program: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - | Mnemonic: LT2
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - | Echo: ECHO_OFF
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - | Expectation: NEVER
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - |
[2024-08-30T22:29:05.829Z] STF 22:29:05.699 - Running command: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java -Xmx256m -Dcom.sun.management.jmxremote.port=1234 -Dcom.sun.management.jmxremote.authenticate=false -Dcom.sun.management.jmxremote.ssl=false -XX:+UseCompressedOops -classpath /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/STF/stf.load/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/STF/stf.core/bin:/home/jenkins/testDependency/system_lib/log4j/log4j-api.jar:/home/jenkins/testDependency/system_lib/log4j/log4j-core.jar:/home/jenkins/testDependency/system_lib/junit/junit.jar:/home/jenkins/testDependency/system_lib/junit/hamcrest-core.jar:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.lang/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.util/bin:/home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.math/bin net.adoptopenjdk.loadTest.LoadTest -resultsDir /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results -resultsPrefix 5.LT2. -timeLimit 30m -abortAtFailureLimit -1 -reportFailureLimit 1 -maxTotalLogFileSpace 200M -maxSingleLogSize 1/25 -suite.mini-mix.totalNumberTests 20000000 -suite.mini-mix.inventoryFile /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/util/util_exclude.xml -suite.mini-mix.threadCount 30 -suite.mini-mix.selection random -suite.mini-mix.seed -1 -suite.mini-mix.repeatCount 1 -suite.mini-mix.thinkingTime 0ms..0ms
[2024-08-30T22:29:05.829Z] STF 22:29:05.700 - Redirecting stderr to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/5.LT2.stderr
[2024-08-30T22:29:05.829Z] STF 22:29:05.700 - Redirecting stdout to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/5.LT2.stdout
[2024-08-30T22:29:05.829Z] STF 22:29:05.706 -
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - +------ Step 6 - Running the Monitoring Client with server-connection(without security)
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - | Start background process
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - | Program: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - | Mnemonic: CL2
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - | Echo: ECHO_ON
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - | Expectation: CLEAN_RUN within 30m
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - |
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - Running command: /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:+UseCompressedOops -classpath /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/jvmtest/system/aqa-systemtest/openjdk.test.jlm/bin:/home/jenkins/testDependency/system_lib/junit/junit.jar net.adoptopenjdk.test.jlm.remote.ThreadProfiler server /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/thd_proxy.log /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - Redirecting stderr to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/6.CL2.stderr
[2024-08-30T22:29:05.829Z] STF 22:29:05.707 - Redirecting stdout to /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/results/6.CL2.stdout
[2024-08-30T22:29:05.829Z] STF 22:29:05.714 -
[2024-08-30T22:29:05.829Z] STF 22:29:05.715 - +------ Step 7 - Wait for processes to complete
[2024-08-30T22:29:05.829Z] STF 22:29:05.715 - | Wait for processes to meet expectations
[2024-08-30T22:29:05.829Z] STF 22:29:05.715 - | Processes: [LT2, CL2]
[2024-08-30T22:29:05.829Z] STF 22:29:05.715 - |
[2024-08-30T22:29:05.829Z] STF 22:29:05.720 - Monitoring processes: CL2 LT2
[2024-08-30T22:29:05.829Z] STF 22:29:05.721 - Heartbeat: Process CL2 is still running
[2024-08-30T22:29:06.632Z] CL2 stderr Picked up JAVA_TOOL_OPTIONS: -Djava.security.manager=allow
[2024-08-30T22:29:08.195Z] CL2 j> 2024/08/30 22:29:06.790 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi
[2024-08-30T22:29:08.195Z] CL2 j> 2024/08/30 22:29:07.498 Attempting to connect
[2024-08-30T22:29:08.976Z] CL2 j> 2024/08/30 22:29:08.567 Monitored VM not ready at Aug 30, 2024, 10:29:08 PM (attempt 1, elapsed 892ms).
[2024-08-30T22:29:08.976Z] CL2 j> 2024/08/30 22:29:08.567 Waiting 5 secs and trying again...
[2024-08-30T22:29:14.719Z] CL2 j> 2024/08/30 22:29:13.617 Attempting to connect
[2024-08-30T22:29:19.650Z] CL2 j> 2024/08/30 22:29:18.061 Connection established!
[2024-08-30T22:29:43.445Z] CL2 j> 2024/08/30 22:29:40.874 Writing report data ...
[2024-08-30T22:30:33.938Z] CL2 j> 2024/08/30 22:30:29.297 done.
[2024-08-30T22:30:41.403Z] CL2 j> 2024/08/30 22:30:40.849 Writing report data ...
[2024-08-30T22:31:18.502Z] CL2 j> 2024/08/30 22:31:16.470 done.
[2024-08-30T22:31:29.110Z] CL2 j> 2024/08/30 22:31:27.396 Writing report data ...
[2024-08-30T22:31:55.989Z] CL2 j> 2024/08/30 22:31:54.173 done.
[2024-08-30T22:32:06.475Z] CL2 j> 2024/08/30 22:32:05.167 Writing report data ...
[2024-08-30T22:32:33.510Z] CL2 j> 2024/08/30 22:32:28.785 done.
[2024-08-30T22:32:41.755Z] CL2 j> 2024/08/30 22:32:40.029 Writing report data ...
[2024-08-30T22:33:05.009Z] CL2 j> 2024/08/30 22:33:03.806 done.
[2024-08-30T22:33:17.402Z] CL2 j> 2024/08/30 22:33:15.067 Writing report data ...
[2024-08-30T22:33:44.263Z] CL2 j> 2024/08/30 22:33:43.150 done.
[2024-08-30T22:33:56.701Z] CL2 j> 2024/08/30 22:33:54.734 Writing report data ...
[2024-08-30T22:34:05.881Z] STF 22:34:05.251 - Heartbeat: Process CL2 is still running
[2024-08-30T22:34:22.942Z] CL2 j> 2024/08/30 22:34:19.874 done.
[2024-08-30T22:34:31.992Z] CL2 j> 2024/08/30 22:34:31.038 Writing report data ...
[2024-08-30T22:35:04.843Z] CL2 j> 2024/08/30 22:35:01.252 done.
[2024-08-30T22:35:13.803Z] CL2 j> 2024/08/30 22:35:12.466 Writing report data ...
[2024-08-30T22:35:37.334Z] CL2 j> 2024/08/30 22:35:36.168 done.
[2024-08-30T22:35:48.242Z] CL2 j> 2024/08/30 22:35:46.860 Writing report data ...
[2024-08-30T22:36:05.373Z] CL2 j> 2024/08/30 22:36:02.813 done.
[2024-08-30T22:36:15.881Z] CL2 j> 2024/08/30 22:36:13.823 Writing report data ...
[2024-08-30T22:36:31.220Z] CL2 j> 2024/08/30 22:36:28.922 done.
[2024-08-30T22:36:40.637Z] CL2 j> 2024/08/30 22:36:39.834 Writing report data ...
[2024-08-30T22:37:03.747Z] CL2 j> 2024/08/30 22:36:59.953 done.
[2024-08-30T22:37:12.942Z] CL2 j> 2024/08/30 22:37:10.652 Writing report data ...
[2024-08-30T22:37:30.091Z] CL2 j> 2024/08/30 22:37:28.087 done.
[2024-08-30T22:37:40.850Z] CL2 j> 2024/08/30 22:37:38.923 Writing report data ...
[2024-08-30T22:38:00.752Z] CL2 j> 2024/08/30 22:37:58.276 done.
[2024-08-30T22:38:09.560Z] CL2 j> 2024/08/30 22:38:09.137 Writing report data ...
[2024-08-30T22:38:29.452Z] CL2 j> 2024/08/30 22:38:27.363 done.
[2024-08-30T22:38:40.484Z] CL2 j> 2024/08/30 22:38:38.346 Writing report data ...
[2024-08-30T22:38:57.537Z] CL2 j> 2024/08/30 22:38:54.790 done.
[2024-08-30T22:39:06.657Z] STF 22:39:05.022 - Heartbeat: Process CL2 is still running
[2024-08-30T22:39:06.657Z] CL2 j> 2024/08/30 22:39:05.568 Writing report data ...
[2024-08-30T22:39:26.652Z] CL2 j> 2024/08/30 22:39:24.386 done.
[2024-08-30T22:39:35.672Z] CL2 j> 2024/08/30 22:39:35.089 Writing report data ...
[2024-08-30T22:39:50.052Z] CL2 j> 2024/08/30 22:39:49.280 done.
[2024-08-30T22:40:01.448Z] CL2 j> 2024/08/30 22:40:00.051 Writing report data ...
[2024-08-30T22:40:18.563Z] CL2 j> 2024/08/30 22:40:15.387 done.
[2024-08-30T22:40:27.338Z] CL2 j> 2024/08/30 22:40:25.990 Writing report data ...
[2024-08-30T22:40:41.987Z] CL2 j> 2024/08/30 22:40:39.990 done.
[2024-08-30T22:40:51.002Z] CL2 j> 2024/08/30 22:40:50.582 Writing report data ...
[2024-08-30T22:41:05.637Z] CL2 j> 2024/08/30 22:41:04.063 done.
[2024-08-30T22:41:16.187Z] CL2 j> 2024/08/30 22:41:14.661 Writing report data ...
[2024-08-30T22:41:28.554Z] CL2 j> 2024/08/30 22:41:27.198 done.
[2024-08-30T22:41:39.875Z] CL2 j> 2024/08/30 22:41:37.553 Writing report data ...
[2024-08-30T22:41:54.596Z] CL2 j> 2024/08/30 22:41:53.032 done.
[2024-08-30T22:42:05.398Z] CL2 j> 2024/08/30 22:42:03.579 Writing report data ...
[2024-08-30T22:42:17.811Z] CL2 j> 2024/08/30 22:42:17.033 done.
[2024-08-30T22:42:28.641Z] CL2 j> 2024/08/30 22:42:27.755 Writing report data ...
[2024-08-30T22:42:43.396Z] CL2 j> 2024/08/30 22:42:42.221 done.
[2024-08-30T22:42:54.427Z] CL2 j> 2024/08/30 22:42:52.697 Writing report data ...
[2024-08-30T22:43:05.467Z] CL2 j> 2024/08/30 22:43:03.442 done.
[2024-08-30T22:43:15.979Z] CL2 j> 2024/08/30 22:43:13.734 Writing report data ...
[2024-08-30T22:43:26.355Z] CL2 j> 2024/08/30 22:43:23.982 done.
[2024-08-30T22:43:36.695Z] CL2 j> 2024/08/30 22:43:34.563 Writing report data ...
[2024-08-30T22:43:48.879Z] CL2 j> 2024/08/30 22:43:47.206 done.
[2024-08-30T22:43:59.359Z] CL2 j> 2024/08/30 22:43:57.749 Writing report data ...
[2024-08-30T22:44:06.602Z] STF 22:44:05.067 - Heartbeat: Process CL2 is still running
[2024-08-30T22:44:11.376Z] CL2 j> 2024/08/30 22:44:09.777 done.
[2024-08-30T22:44:21.754Z] CL2 j> 2024/08/30 22:44:20.367 Writing report data ...
[2024-08-30T22:44:36.254Z] CL2 j> 2024/08/30 22:44:33.895 done.
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - Monitoring Report Summary:
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - o Process CL2 ended with the expected exit code (0)
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - o Process LT2 is still running as expected
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 -
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - +------ Step 8 - Stop LT2 process
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - | Kill running processes
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - | Processes: [LT2]
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - |
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - Killing processes: LT2
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - o Process clean up attempt 1 for LT2 pid 1386171
[2024-08-30T22:44:36.254Z] STF 22:44:35.800 - o Process LT2 pid 1386171 stop()
[2024-08-30T22:44:47.153Z] STF 22:44:45.983 - o Process LT2 pid 1386171 terminate()
[2024-08-30T22:44:47.918Z] STF 22:44:46.984 - o Process LT2 pid 1386171 killed
[2024-08-30T22:44:47.918Z] STF 22:44:46.985 - EXECUTE stage completed
[2024-08-30T22:44:47.918Z] STF 22:44:47.201 -
[2024-08-30T22:44:47.918Z] STF 22:44:47.204 - ==================== T E A R D O W N ====================
[2024-08-30T22:44:47.918Z] STF 22:44:47.204 - Running teardown: perl /home/jenkins/workspace/Test_openjdk21_hs_sanity.system_aarch64_linux_testList_1/aqa-tests/TKG/../TKG/output_17250508349972/TestJlmRemoteThreadNoAuth_0/20240830-221857-TestJlmRemoteThreadNoAuth/tearDown.pl
[2024-08-30T22:44:47.918Z] STF 22:44:47.469 - TEARDOWN stage completed
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 -
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 - ===================== R E S U L T S =====================
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 - Stage results:
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 - setUp: pass
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 - execute: pass
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 - teardown: pass
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 -
[2024-08-30T22:44:47.918Z] STF 22:44:47.476 - Overall result: PASSED
[2024-08-30T22:44:47.918Z] -----------------------------------
[2024-08-30T22:44:47.918Z] TestJlmRemoteThreadNoAuth_0_PASSED
[2024-08-30T22:44:47.918Z] -----------------------------------
[2024-08-30T22:44:47.918Z]
[2024-08-30T22:44:47.918Z] TEST TEARDOWN:
[2024-08-30T22:44:47.918Z] Nothing to be done for teardown.
[2024-08-30T22:44:47.918Z] TestJlmRemoteThreadNoAuth_0 Finish Time: Fri Aug 30 22:44:47 2024 Epoch Time (ms): 1725057887655