[2024-10-31T06:36:08.482Z] Running test TestJlmRemoteThreadNoAuth_0 ... [2024-10-31T06:36:08.482Z] =============================================== [2024-10-31T06:36:08.482Z] TestJlmRemoteThreadNoAuth_0 Start Time: Thu Oct 31 06:35:55 2024 Epoch Time (ms): 1730356555692 [2024-10-31T06:36:08.482Z] variation: Mode150 [2024-10-31T06:36:08.482Z] JVM_OPTIONS: -XX:+UseCompressedOops [2024-10-31T06:36:08.482Z] { \ [2024-10-31T06:36:08.482Z] echo ""; echo "TEST SETUP:"; \ [2024-10-31T06:36:08.482Z] echo "Nothing to be done for setup."; \ [2024-10-31T06:36:08.482Z] mkdir -p "C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17303537463304\\TestJlmRemoteThreadNoAuth_0"; \ [2024-10-31T06:36:08.482Z] cd "C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17303537463304\\TestJlmRemoteThreadNoAuth_0"; \ [2024-10-31T06:36:08.482Z] echo ""; echo "TESTING:"; \ [2024-10-31T06:36:08.482Z] perl C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests///..//jvmtest\\system\\jlm/../\\STF\\stf.core\\scripts\\stf.pl -test-root="C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests///..//jvmtest\\system\\jlm/../\\STF;C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests///..//jvmtest\\system\\jlm/../\\aqa-systemtest""" -systemtest-prereqs="c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\\" -java-args=' -XX:+UseCompressedOops ' -results-root="C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17303537463304\\TestJlmRemoteThreadNoAuth_0" -test=TestJlmRemoteThreadNoAuth; \ [2024-10-31T06:36:08.482Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_0""_PASSED"; echo "-----------------------------------"; cd C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/; rm -f -r "C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17303537463304\\TestJlmRemoteThreadNoAuth_0"; else echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_0""_FAILED"; echo "-----------------------------------"; fi; \ [2024-10-31T06:36:08.482Z] echo ""; echo "TEST TEARDOWN:"; \ [2024-10-31T06:36:08.482Z] echo "Nothing to be done for teardown."; \ [2024-10-31T06:36:08.482Z] } 2>&1 | tee -a "C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17303537463304\\TestTargetResult"; [2024-10-31T06:36:08.482Z] [2024-10-31T06:36:08.482Z] TEST SETUP: [2024-10-31T06:36:08.482Z] Nothing to be done for setup. [2024-10-31T06:36:08.482Z] [2024-10-31T06:36:08.482Z] TESTING: [2024-10-31T06:36:08.482Z] STF 06:35:56.245 - ========================= S T F ========================= [2024-10-31T06:36:08.482Z] systemtest-prereqs has been processed, and set to: c:/jenkins/testDependency/system_libRetrieving amount of free space on drive containing C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0 [2024-10-31T06:36:08.482Z] There is 127113 Mb free [2024-10-31T06:36:08.482Z] STF 06:35:56.293 - ================== G E N E R A T I O N ================== [2024-10-31T06:36:08.482Z] STF 06:35:56.295 - Checking JVM: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image [2024-10-31T06:36:08.482Z] STF 06:35:56.295 - Starting process to generate scripts: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -Dlog4j.skipJansi=true -Djava.system.class.loader=net.adoptopenjdk.stf.runner.StfClassLoader -classpath c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\/log4j/log4j-api.jar;c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\/log4j/log4j-core.jar;C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jvmtest/system/STF/stf.core/scripts/../bin net.adoptopenjdk.stf.runner.StfRunner -properties "C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/stf_parameters.properties, , C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jvmtest/system/STF/stf.core/config/stf.properties" -testDir "C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth" [2024-10-31T06:36:08.482Z] GEN stderr OpenJDK 64-Bit Server VM warning: 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-10-31T06:36:08.482Z] GEN 06:35:57.130 - Found test. Project: 'openjdk.test.jlm' class: 'TestJlmRemoteThreadNoAuth.class' Dir: 'C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.jlm\bin' [2024-10-31T06:36:08.482Z] GEN 06:35:57.180 - Found test. Project: 'openjdk.test.jlm' class: 'net.adoptopenjdk.test.jlm.TestJlmRemoteThreadNoAuth' [2024-10-31T06:36:08.482Z] GEN Classpath directories used by project 'openjdk.test.jlm': [2024-10-31T06:36:08.482Z] GEN C:\\jenkins\\workspace\\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\\jvmtest\\system\\aqa-systemtest\\openjdk.test.jlm\\bin [2024-10-31T06:36:08.482Z] GEN C:\\jenkins\\workspace\\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\\jvmtest\\system\\STF\\stf.core\\bin [2024-10-31T06:36:08.482Z] GEN c:/jenkins/testDependency/system_lib/log4j/log4j-api.jar [2024-10-31T06:36:08.482Z] GEN c:/jenkins/testDependency/system_lib/log4j/log4j-core.jar [2024-10-31T06:36:08.482Z] GEN c:/jenkins/testDependency/system_lib/junit/junit.jar [2024-10-31T06:36:08.482Z] GEN 06:35:57.424 - Using Mode NoOptions. Values = '' [2024-10-31T06:36:08.482Z] GEN 06:35:57.540 - [2024-10-31T06:36:08.482Z] GEN 06:35:57.541 - Test command summary: [2024-10-31T06:36:08.482Z] GEN 06:35:57.541 - Step Stage Command Description [2024-10-31T06:36:08.482Z] GEN 06:35:57.541 - -----+--------+-----------------+------------ [2024-10-31T06:36:08.482Z] GEN 06:35:57.541 - 1 execute Run java Running ThreadProfiler Proxy test Server Process [2024-10-31T06:36:08.482Z] GEN 06:35:57.541 - 2 execute Run java Running the monitoring Client with proxy connection(without security) [2024-10-31T06:36:08.483Z] GEN 06:35:57.542 - 3 execute Monitor Wait for processes to complete [2024-10-31T06:36:08.483Z] GEN 06:35:57.542 - 4 execute kill Stop LT1 process [2024-10-31T06:36:08.483Z] GEN 06:35:57.542 - 5 execute Run java Running ThreadProfiler Server test Server Process(without security) [2024-10-31T06:36:08.483Z] GEN 06:35:57.542 - 6 execute Run java Running the Monitoring Client with server-connection(without security) [2024-10-31T06:36:08.483Z] GEN 06:35:57.542 - 7 execute Monitor Wait for processes to complete [2024-10-31T06:36:08.483Z] GEN 06:35:57.542 - 8 execute kill Stop LT2 process [2024-10-31T06:36:08.483Z] STF 06:35:57.577 - [2024-10-31T06:36:08.483Z] STF 06:35:57.577 - Script generation completed [2024-10-31T06:36:08.483Z] STF 06:35:57.577 - [2024-10-31T06:36:08.483Z] STF 06:35:57.579 - [2024-10-31T06:36:08.483Z] STF 06:35:57.579 - ======================= S E T U P ======================= [2024-10-31T06:36:08.483Z] STF 06:35:57.579 - Running setup: perl C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/setUp.pl [2024-10-31T06:36:08.483Z] STF 06:35:57.709 - SETUP stage completed [2024-10-31T06:36:08.483Z] STF 06:35:57.719 - [2024-10-31T06:36:08.483Z] STF 06:35:57.719 - ==================== E X E C U T E - ==================== [2024-10-31T06:36:08.483Z] STF 06:35:57.719 - Running execute: perl C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/execute.pl [2024-10-31T06:36:08.483Z] STF 06:35:57.848 - [2024-10-31T06:36:08.483Z] STF 06:35:57.848 - Java version [2024-10-31T06:36:08.483Z] STF 06:35:57.848 - Running: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -version [2024-10-31T06:36:08.483Z] openjdk version "17.0.14-beta" 2025-01-21 [2024-10-31T06:36:08.483Z] OpenJDK Runtime Environment Temurin-17.0.14+1-202410302036 (build 17.0.14-beta+1-ea) [2024-10-31T06:36:08.483Z] OpenJDK 64-Bit Server VM Temurin-17.0.14+1-202410302036 (build 17.0.14-beta+1-ea, mixed mode, sharing) [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - +------ Step 1 - Running ThreadProfiler Proxy test Server Process [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - | Start background process [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - | Program: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - | Mnemonic: LT1 [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - | Echo: ECHO_OFF [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - | Expectation: NEVER [2024-10-31T06:36:08.483Z] STF 06:35:57.937 - | [2024-10-31T06:36:08.483Z] STF 06:35:57.938 - Running command: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/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 C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.load\bin;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.core\bin;c:/jenkins/testDependency/system_lib/log4j/log4j-api.jar;c:/jenkins/testDependency/system_lib/log4j/log4j-core.jar;c:/jenkins/testDependency/system_lib/junit/junit.jar;c:/jenkins/testDependency/system_lib/junit/hamcrest-core.jar;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.lang\bin;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.util\bin;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.math\bin net.adoptopenjdk.loadTest.LoadTest -resultsDir C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\aqa-tests\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0\20241031-063556-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 C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-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-10-31T06:36:08.483Z] STF 06:35:57.938 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/1.LT1.stderr [2024-10-31T06:36:08.483Z] STF 06:35:57.938 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/1.LT1.stdout [2024-10-31T06:36:08.483Z] STF 06:35:57.969 - [2024-10-31T06:36:08.483Z] STF 06:35:57.969 - +------ Step 2 - Running the monitoring Client with proxy connection(without security) [2024-10-31T06:36:08.483Z] STF 06:35:57.969 - | Start background process [2024-10-31T06:36:08.483Z] STF 06:35:57.969 - | Program: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2024-10-31T06:36:08.483Z] STF 06:35:57.970 - | Mnemonic: CL1 [2024-10-31T06:36:08.483Z] STF 06:35:57.970 - | Echo: ECHO_ON [2024-10-31T06:36:08.483Z] STF 06:35:57.970 - | Expectation: CLEAN_RUN within 30m [2024-10-31T06:36:08.483Z] STF 06:35:57.970 - | [2024-10-31T06:36:08.483Z] STF 06:35:57.970 - Running command: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:+UseCompressedOops -classpath C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.jlm\bin;c:/jenkins/testDependency/system_lib/junit/junit.jar net.adoptopenjdk.test.jlm.remote.ThreadProfiler proxy C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/thd_proxy.log C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234 [2024-10-31T06:36:08.483Z] STF 06:35:57.970 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/2.CL1.stderr [2024-10-31T06:36:08.483Z] STF 06:35:57.970 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/2.CL1.stdout [2024-10-31T06:36:08.483Z] STF 06:35:57.976 - [2024-10-31T06:36:08.483Z] STF 06:35:57.977 - +------ Step 3 - Wait for processes to complete [2024-10-31T06:36:08.483Z] STF 06:35:57.977 - | Wait for processes to meet expectations [2024-10-31T06:36:08.483Z] STF 06:35:57.977 - | Processes: [LT1, CL1] [2024-10-31T06:36:08.483Z] STF 06:35:57.977 - | [2024-10-31T06:36:08.483Z] STF 06:35:57.977 - Monitoring processes: CL1 LT1 [2024-10-31T06:36:08.483Z] CL1 j> 2024/10/31 06:35:58.153 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi [2024-10-31T06:36:08.483Z] CL1 j> 2024/10/31 06:35:58.218 Attempting to connect [2024-10-31T06:36:08.483Z] CL1 j> 2024/10/31 06:35:58.420 Monitored VM not ready at Oct 31, 2024, 6:35:58 AM (attempt 1, elapsed 179ms). [2024-10-31T06:36:08.483Z] CL1 j> 2024/10/31 06:35:58.421 Waiting 5 secs and trying again... [2024-10-31T06:36:08.483Z] CL1 j> 2024/10/31 06:36:03.456 Attempting to connect [2024-10-31T06:36:13.090Z] CL1 j> 2024/10/31 06:36:08.788 Connection established! [2024-10-31T06:36:18.216Z] CL1 j> 2024/10/31 06:36:13.927 Starting to write data [2024-10-31T06:41:05.907Z] STF 06:40:57.252 - Heartbeat: Process CL1 is still running [2024-10-31T06:41:50.193Z] STF 06:41:44.063 - Monitoring Report Summary: [2024-10-31T06:41:50.193Z] STF 06:41:44.063 - o Process CL1 ended with the expected exit code (0) [2024-10-31T06:41:50.193Z] STF 06:41:44.063 - o Process LT1 is still running as expected [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - +------ Step 4 - Stop LT1 process [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - | Kill running processes [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - | Processes: [LT1] [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - | [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - Killing processes: LT1 [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - o Process clean up attempt 1 for LT1 pid 65696 [2024-10-31T06:41:50.193Z] STF 06:41:44.064 - o Process LT1 pid 65696 stop() [2024-10-31T06:41:50.193Z] STF 06:41:44.143 - o Process LT1 pid 65696 killed [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - +------ Step 5 - Running ThreadProfiler Server test Server Process(without security) [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - | Start background process [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - | Program: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - | Mnemonic: LT2 [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - | Echo: ECHO_OFF [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - | Expectation: NEVER [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - | [2024-10-31T06:41:50.193Z] STF 06:41:44.144 - Running command: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/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 C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.load\bin;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.core\bin;c:/jenkins/testDependency/system_lib/log4j/log4j-api.jar;c:/jenkins/testDependency/system_lib/log4j/log4j-core.jar;c:/jenkins/testDependency/system_lib/junit/junit.jar;c:/jenkins/testDependency/system_lib/junit/hamcrest-core.jar;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.lang\bin;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.util\bin;C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.math\bin net.adoptopenjdk.loadTest.LoadTest -resultsDir C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\aqa-tests\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0\20241031-063556-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 C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-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-10-31T06:41:50.193Z] STF 06:41:44.145 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/5.LT2.stderr [2024-10-31T06:41:50.193Z] STF 06:41:44.145 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/5.LT2.stdout [2024-10-31T06:41:50.193Z] STF 06:41:44.161 - [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - +------ Step 6 - Running the Monitoring Client with server-connection(without security) [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - | Start background process [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - | Program: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - | Mnemonic: CL2 [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - | Echo: ECHO_ON [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - | Expectation: CLEAN_RUN within 30m [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - | [2024-10-31T06:41:50.193Z] STF 06:41:44.162 - Running command: c:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:+UseCompressedOops -classpath C:\jenkins\workspace\Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.jlm\bin;c:/jenkins/testDependency/system_lib/junit/junit.jar net.adoptopenjdk.test.jlm.remote.ThreadProfiler server C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/thd_proxy.log C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234 [2024-10-31T06:41:50.194Z] STF 06:41:44.162 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/6.CL2.stderr [2024-10-31T06:41:50.194Z] STF 06:41:44.162 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17303537463304/TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/results/6.CL2.stdout [2024-10-31T06:41:50.194Z] STF 06:41:44.169 - [2024-10-31T06:41:50.194Z] STF 06:41:44.169 - +------ Step 7 - Wait for processes to complete [2024-10-31T06:41:50.194Z] STF 06:41:44.169 - | Wait for processes to meet expectations [2024-10-31T06:41:50.194Z] STF 06:41:44.169 - | Processes: [LT2, CL2] [2024-10-31T06:41:50.194Z] STF 06:41:44.169 - | [2024-10-31T06:41:50.194Z] STF 06:41:44.169 - Monitoring processes: CL2 LT2 [2024-10-31T06:41:50.194Z] CL2 j> 2024/10/31 06:41:44.378 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi [2024-10-31T06:41:50.194Z] CL2 j> 2024/10/31 06:41:44.445 Attempting to connect [2024-10-31T06:41:50.194Z] CL2 j> 2024/10/31 06:41:44.632 Monitored VM not ready at Oct 31, 2024, 6:41:44 AM (attempt 1, elapsed 164ms). [2024-10-31T06:41:50.194Z] CL2 j> 2024/10/31 06:41:44.632 Waiting 5 secs and trying again... [2024-10-31T06:41:56.425Z] CL2 j> 2024/10/31 06:41:49.940 Attempting to connect [2024-10-31T06:41:56.425Z] CL2 j> 2024/10/31 06:41:51.309 Connection established! [2024-10-31T06:42:07.933Z] CL2 j> 2024/10/31 06:42:04.099 Writing report data ... [2024-10-31T06:42:09.427Z] CL2 j> 2024/10/31 06:42:07.118 done. [2024-10-31T06:42:22.316Z] CL2 j> 2024/10/31 06:42:17.777 Writing report data ... [2024-10-31T06:42:23.829Z] CL2 j> 2024/10/31 06:42:20.516 done. [2024-10-31T06:42:35.520Z] CL2 j> 2024/10/31 06:42:30.952 Writing report data ... [2024-10-31T06:42:37.040Z] CL2 j> 2024/10/31 06:42:31.576 done. [2024-10-31T06:42:46.886Z] CL2 j> 2024/10/31 06:42:41.824 Writing report data ... [2024-10-31T06:42:46.886Z] CL2 j> 2024/10/31 06:42:42.410 done. [2024-10-31T06:42:58.530Z] CL2 j> 2024/10/31 06:42:52.733 Writing report data ... [2024-10-31T06:42:58.530Z] CL2 j> 2024/10/31 06:42:53.106 done. [2024-10-31T06:43:08.603Z] CL2 j> 2024/10/31 06:43:03.254 Writing report data ... [2024-10-31T06:43:09.987Z] CL2 j> 2024/10/31 06:43:04.232 done. [2024-10-31T06:43:17.836Z] CL2 j> 2024/10/31 06:43:14.444 Writing report data ... [2024-10-31T06:43:21.005Z] CL2 j> 2024/10/31 06:43:14.873 done. [2024-10-31T06:43:29.248Z] CL2 j> 2024/10/31 06:43:25.113 Writing report data ... [2024-10-31T06:43:34.576Z] CL2 j> 2024/10/31 06:43:25.967 done. [2024-10-31T06:43:39.062Z] CL2 j> 2024/10/31 06:43:36.328 Writing report data ... [2024-10-31T06:43:42.303Z] CL2 j> 2024/10/31 06:43:36.796 done. [2024-10-31T06:43:50.130Z] CL2 j> 2024/10/31 06:43:46.948 Writing report data ... [2024-10-31T06:43:50.130Z] CL2 j> 2024/10/31 06:43:47.273 done. [2024-10-31T06:44:01.124Z] CL2 j> 2024/10/31 06:43:57.708 Writing report data ... [2024-10-31T06:44:01.124Z] CL2 j> 2024/10/31 06:43:58.069 done. [2024-10-31T06:44:12.955Z] CL2 j> 2024/10/31 06:44:08.479 Writing report data ... [2024-10-31T06:44:12.955Z] CL2 j> 2024/10/31 06:44:09.321 done. [2024-10-31T06:44:26.890Z] CL2 j> 2024/10/31 06:44:20.032 Writing report data ... [2024-10-31T06:44:26.890Z] CL2 j> 2024/10/31 06:44:20.415 done. [2024-10-31T06:44:33.485Z] CL2 j> 2024/10/31 06:44:30.707 Writing report data ... [2024-10-31T06:44:36.812Z] CL2 j> 2024/10/31 06:44:31.345 done. [2024-10-31T06:44:46.303Z] CL2 j> 2024/10/31 06:44:41.535 Writing report data ... [2024-10-31T06:44:46.303Z] CL2 j> 2024/10/31 06:44:41.956 done. [2024-10-31T06:44:54.280Z] CL2 j> 2024/10/31 06:44:52.066 Writing report data ... [2024-10-31T06:44:58.585Z] CL2 j> 2024/10/31 06:44:52.462 done. [2024-10-31T06:45:06.430Z] CL2 j> 2024/10/31 06:45:02.937 Writing report data ... [2024-10-31T06:45:06.430Z] CL2 j> 2024/10/31 06:45:03.885 done. [2024-10-31T06:45:18.155Z] CL2 j> 2024/10/31 06:45:14.204 Writing report data ... [2024-10-31T06:45:21.536Z] CL2 j> 2024/10/31 06:45:15.151 done. [2024-10-31T06:45:29.963Z] CL2 j> 2024/10/31 06:45:26.155 Writing report data ... [2024-10-31T06:45:29.963Z] CL2 j> 2024/10/31 06:45:26.679 done. [2024-10-31T06:45:40.094Z] CL2 j> 2024/10/31 06:45:37.247 Writing report data ... [2024-10-31T06:45:40.094Z] CL2 j> 2024/10/31 06:45:37.735 done. [2024-10-31T06:45:57.690Z] CL2 j> 2024/10/31 06:45:48.449 Writing report data ... [2024-10-31T06:45:57.690Z] CL2 j> 2024/10/31 06:45:48.773 done. [2024-10-31T06:45:58.255Z] STF 06:45:57.332 - Heartbeat: Process LT2 is still running [2024-10-31T06:46:03.006Z] CL2 j> 2024/10/31 06:45:58.994 Writing report data ... [2024-10-31T06:46:04.365Z] CL2 j> 2024/10/31 06:45:59.535 done. [2024-10-31T06:46:13.889Z] CL2 j> 2024/10/31 06:46:10.592 Writing report data ... [2024-10-31T06:46:16.479Z] CL2 j> 2024/10/31 06:46:11.298 done. [2024-10-31T06:46:26.410Z] CL2 j> 2024/10/31 06:46:21.666 Writing report data ... [2024-10-31T06:46:26.410Z] CL2 j> 2024/10/31 06:46:22.017 done. [2024-10-31T06:46:37.321Z] CL2 j> 2024/10/31 06:46:32.280 Writing report data ... [2024-10-31T06:46:37.321Z] CL2 j> 2024/10/31 06:46:32.675 done. [2024-10-31T06:46:47.793Z] CL2 j> 2024/10/31 06:46:42.962 Writing report data ... [2024-10-31T06:46:47.793Z] CL2 j> 2024/10/31 06:46:43.330 done. [2024-10-31T06:46:58.479Z] CL2 j> 2024/10/31 06:46:54.468 Writing report data ... [2024-10-31T06:47:03.472Z] CL2 j> 2024/10/31 06:46:55.295 done. [2024-10-31T06:47:10.566Z] CL2 j> 2024/10/31 06:47:05.598 Writing report data ... [2024-10-31T06:47:10.566Z] CL2 j> 2024/10/31 06:47:06.111 done. [2024-10-31T06:47:21.133Z] CL2 j> 2024/10/31 06:47:16.852 Writing report data ... [2024-10-31T06:47:21.785Z] CL2 j> 2024/10/31 06:47:17.176 done. [2024-10-31T06:47:31.488Z] CL2 j> 2024/10/31 06:47:28.159 Writing report data ... [2024-10-31T06:47:34.995Z] CL2 j> 2024/10/31 06:47:28.691 done. [2024-10-31T06:47:41.661Z] STF 06:47:40.517 - Monitoring Report Summary: [2024-10-31T06:47:41.661Z] STF 06:47:40.517 - o Process CL2 ended with the expected exit code (0) [2024-10-31T06:47:41.661Z] STF 06:47:40.517 - o Process LT2 is still running as expected [2024-10-31T06:47:41.661Z] STF 06:47:40.642 - [2024-10-31T06:47:41.661Z] STF 06:47:40.642 - +------ Step 8 - Stop LT2 process [2024-10-31T06:47:41.661Z] STF 06:47:40.642 - | Kill running processes [2024-10-31T06:47:41.661Z] STF 06:47:40.697 - | Processes: [LT2] [2024-10-31T06:47:41.661Z] STF 06:47:40.697 - | [2024-10-31T06:47:41.661Z] STF 06:47:40.753 - Killing processes: LT2 [2024-10-31T06:47:41.661Z] STF 06:47:40.754 - o Process clean up attempt 1 for LT2 pid 32576 [2024-10-31T06:47:41.661Z] STF 06:47:40.754 - o Process LT2 pid 32576 stop() [2024-10-31T06:47:41.661Z] STF 06:47:40.814 - o Process LT2 pid 32576 killed [2024-10-31T06:47:41.661Z] STF 06:47:40.814 - EXECUTE stage completed [2024-10-31T06:47:41.661Z] STF 06:47:40.836 - [2024-10-31T06:47:41.661Z] STF 06:47:40.836 - ==================== T E A R D O W N ==================== [2024-10-31T06:47:41.661Z] STF 06:47:40.836 - Running teardown: perl C:/jenkins/workspace/Test_openjdk17_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17303537463304\TestJlmRemoteThreadNoAuth_0/20241031-063556-TestJlmRemoteThreadNoAuth/tearDown.pl [2024-10-31T06:47:41.661Z] STF 06:47:40.982 - TEARDOWN stage completed [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - ===================== R E S U L T S ===================== [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - Stage results: [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - setUp: pass [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - execute: pass [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - teardown: pass [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - [2024-10-31T06:47:41.661Z] STF 06:47:40.998 - Overall result: PASSED [2024-10-31T06:47:41.661Z] ----------------------------------- [2024-10-31T06:47:41.661Z] TestJlmRemoteThreadNoAuth_0_PASSED [2024-10-31T06:47:41.661Z] ----------------------------------- [2024-10-31T06:47:41.661Z] [2024-10-31T06:47:41.661Z] TEST TEARDOWN: [2024-10-31T06:47:41.661Z] Nothing to be done for teardown. [2024-10-31T06:47:41.661Z] TestJlmRemoteThreadNoAuth_0 Finish Time: Thu Oct 31 06:47:41 2024 Epoch Time (ms): 1730357261159