[2025-06-19T19:11:42.353Z] Running test TestJlmRemoteThreadNoAuth_0 ... [2025-06-19T19:11:42.353Z] =============================================== [2025-06-19T19:11:42.353Z] TestJlmRemoteThreadNoAuth_0 Start Time: Thu Jun 19 19:11:41 2025 Epoch Time (ms): 1750360301668 [2025-06-19T19:11:42.353Z] variation: Mode150 [2025-06-19T19:11:42.353Z] JVM_OPTIONS: -XX:+UseCompressedOops [2025-06-19T19:11:42.353Z] { \ [2025-06-19T19:11:42.353Z] echo ""; echo "TEST SETUP:"; \ [2025-06-19T19:11:42.353Z] echo "Nothing to be done for setup."; \ [2025-06-19T19:11:42.353Z] mkdir -p "C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17503595188227\\TestJlmRemoteThreadNoAuth_0"; \ [2025-06-19T19:11:42.353Z] cd "C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17503595188227\\TestJlmRemoteThreadNoAuth_0"; \ [2025-06-19T19:11:42.353Z] echo ""; echo "TESTING:"; \ [2025-06-19T19:11:42.353Z] perl C:/jenkins/workspace/Test_openjdk11_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_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests///..//jvmtest\\system\\jlm/../\\STF;C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests///..//jvmtest\\system\\jlm/../\\aqa-systemtest""" -systemtest-prereqs="c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\\" -java-args=' -XX:+UseCompressedOops ' -results-root="C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17503595188227\\TestJlmRemoteThreadNoAuth_0" -test=TestJlmRemoteThreadNoAuth; \ [2025-06-19T19:11:42.353Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_0""_PASSED"; echo "-----------------------------------"; cd C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/; rm -f -r "C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17503595188227\\TestJlmRemoteThreadNoAuth_0"; else echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-06-19T19:11:42.353Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-06-19T19:11:42.353Z] echo "Nothing to be done for teardown."; \ [2025-06-19T19:11:42.353Z] } 2>&1 | tee -a "C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17503595188227\\TestTargetResult"; [2025-06-19T19:11:42.353Z] [2025-06-19T19:11:42.353Z] TEST SETUP: [2025-06-19T19:11:42.353Z] Nothing to be done for setup. [2025-06-19T19:11:42.353Z] [2025-06-19T19:11:42.353Z] TESTING: [2025-06-19T19:11:42.353Z] STF 19:11:42.253 - ========================= S T F ========================= [2025-06-19T19:11:42.353Z] systemtest-prereqs has been processed, and set to: c:/jenkins/testDependency/system_libRetrieving amount of free space on drive containing C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0 [2025-06-19T19:11:42.724Z] There is 388638 Mb free [2025-06-19T19:11:42.724Z] STF 19:11:42.371 - ================== G E N E R A T I O N ================== [2025-06-19T19:11:42.724Z] STF 19:11:42.374 - Checking JVM: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image [2025-06-19T19:11:42.724Z] STF 19:11:42.375 - Starting process to generate scripts: c:/jenkins/workspace/Test_openjdk11_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 -Dload.agent.path=C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jvmtest/system/STF/stf.core/scripts/../../stf.load/bin/stf.load.jar -classpath c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\/asm/asm.jar;c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\/asm/asm-commons.jar;c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\/log4j/log4j-api.jar;c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/../../testDependency/system_lib\/log4j/log4j-core.jar;C:/jenkins/workspace/Test_openjdk11_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_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/stf_parameters.properties, , C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jvmtest/system/STF/stf.core/config/stf.properties" -testDir "C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth" [2025-06-19T19:11:44.392Z] GEN 19:11:44.086 - Found test. Project: 'openjdk.test.jlm' class: 'TestJlmRemoteThreadNoAuth.class' Dir: 'C:\jenkins\workspace\Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.jlm\bin' [2025-06-19T19:11:44.392Z] GEN 19:11:44.144 - Found test. Project: 'openjdk.test.jlm' class: 'net.adoptopenjdk.test.jlm.TestJlmRemoteThreadNoAuth' [2025-06-19T19:11:44.932Z] GEN Classpath directories used by project 'openjdk.test.jlm': [2025-06-19T19:11:44.932Z] GEN C:\\jenkins\\workspace\\Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0\\jvmtest\\system\\aqa-systemtest\\openjdk.test.jlm\\bin [2025-06-19T19:11:44.932Z] GEN C:\\jenkins\\workspace\\Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0\\jvmtest\\system\\STF\\stf.core\\bin [2025-06-19T19:11:44.932Z] GEN c:/jenkins/testDependency/system_lib/log4j/log4j-api.jar [2025-06-19T19:11:44.932Z] GEN c:/jenkins/testDependency/system_lib/log4j/log4j-core.jar [2025-06-19T19:11:44.932Z] GEN c:/jenkins/testDependency/system_lib/junit/junit.jar [2025-06-19T19:11:44.932Z] GEN 19:11:44.616 - Using Mode NoOptions. Values = '' [2025-06-19T19:11:45.256Z] GEN 19:11:44.917 - [2025-06-19T19:11:45.256Z] GEN 19:11:44.918 - Test command summary: [2025-06-19T19:11:45.256Z] GEN 19:11:44.919 - Step Stage Command Description [2025-06-19T19:11:45.256Z] GEN 19:11:44.919 - -----+--------+-----------------+------------ [2025-06-19T19:11:45.256Z] GEN 19:11:44.919 - 1 execute Run java Running ThreadProfiler Proxy test Server Process [2025-06-19T19:11:45.256Z] GEN 19:11:44.919 - 2 execute Run java Running the monitoring Client with proxy connection(without security) [2025-06-19T19:11:45.256Z] GEN 19:11:44.920 - 3 execute Monitor Wait for processes to complete [2025-06-19T19:11:45.256Z] GEN 19:11:44.920 - 4 execute kill Stop LT1 process [2025-06-19T19:11:45.256Z] GEN 19:11:44.920 - 5 execute Run java Running ThreadProfiler Server test Server Process(without security) [2025-06-19T19:11:45.256Z] GEN 19:11:44.920 - 6 execute Run java Running the Monitoring Client with server-connection(without security) [2025-06-19T19:11:45.256Z] GEN 19:11:44.920 - 7 execute Monitor Wait for processes to complete [2025-06-19T19:11:45.256Z] GEN 19:11:44.920 - 8 execute kill Stop LT2 process [2025-06-19T19:11:45.256Z] STF 19:11:45.014 - [2025-06-19T19:11:45.256Z] STF 19:11:45.014 - Script generation completed [2025-06-19T19:11:45.256Z] STF 19:11:45.014 - [2025-06-19T19:11:45.256Z] STF 19:11:45.026 - [2025-06-19T19:11:45.256Z] STF 19:11:45.026 - ======================= S E T U P ======================= [2025-06-19T19:11:45.256Z] STF 19:11:45.026 - Running setup: perl C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/setUp.pl [2025-06-19T19:11:45.567Z] STF 19:11:45.219 - SETUP stage completed [2025-06-19T19:11:45.567Z] STF 19:11:45.242 - [2025-06-19T19:11:45.567Z] STF 19:11:45.242 - ==================== E X E C U T E - ==================== [2025-06-19T19:11:45.567Z] STF 19:11:45.242 - Running execute: perl C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/execute.pl [2025-06-19T19:11:45.567Z] STF 19:11:45.409 - [2025-06-19T19:11:45.567Z] STF 19:11:45.410 - Java version [2025-06-19T19:11:45.567Z] STF 19:11:45.410 - Running: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -version [2025-06-19T19:11:45.982Z] openjdk version "11.0.28-beta" 2025-07-15 [2025-06-19T19:11:45.982Z] OpenJDK Runtime Environment Temurin-11.0.28+5-202506190024 (build 11.0.28-beta+5-ea) [2025-06-19T19:11:45.982Z] OpenJDK 64-Bit Server VM Temurin-11.0.28+5-202506190024 (build 11.0.28-beta+5-ea, mixed mode) [2025-06-19T19:11:45.982Z] STF 19:11:45.612 - [2025-06-19T19:11:45.982Z] STF 19:11:45.612 - +------ Step 1 - Running ThreadProfiler Proxy test Server Process [2025-06-19T19:11:45.982Z] STF 19:11:45.612 - | Start background process [2025-06-19T19:11:45.982Z] STF 19:11:45.612 - | Program: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-06-19T19:11:45.982Z] STF 19:11:45.612 - | Mnemonic: LT1 [2025-06-19T19:11:45.982Z] STF 19:11:45.612 - | Echo: ECHO_OFF [2025-06-19T19:11:45.982Z] STF 19:11:45.612 - | Expectation: NEVER [2025-06-19T19:11:45.982Z] STF 19:11:45.613 - | [2025-06-19T19:11:45.983Z] STF 19:11:45.613 - Running command: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -javaagent:C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jvmtest/system/STF/stf.core/scripts/../../stf.load/bin/stf.load.jar -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_openjdk11_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.load\bin;C:\jenkins\workspace\Test_openjdk11_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/asm/asm.jar;c:/jenkins/testDependency/system_lib/asm/asm-commons.jar;c:/jenkins/testDependency/system_lib/junit/junit.jar;c:/jenkins/testDependency/system_lib/junit/hamcrest-core.jar;C:\jenkins\workspace\Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.lang\bin;C:\jenkins\workspace\Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.util\bin;C:\jenkins\workspace\Test_openjdk11_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_openjdk11_hs_sanity.system_x86-64_windows_testList_0\aqa-tests\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0\20250619-191142-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_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-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 [2025-06-19T19:11:45.983Z] STF 19:11:45.613 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/1.LT1.stderr [2025-06-19T19:11:45.983Z] STF 19:11:45.613 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/1.LT1.stdout [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - +------ Step 2 - Running the monitoring Client with proxy connection(without security) [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - | Start background process [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - | Program: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - | Mnemonic: CL1 [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - | Echo: ECHO_ON [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - | Expectation: CLEAN_RUN within 30m [2025-06-19T19:11:45.983Z] STF 19:11:45.649 - | [2025-06-19T19:11:45.983Z] STF 19:11:45.650 - Running command: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:+UseCompressedOops -classpath C:\jenkins\workspace\Test_openjdk11_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_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/thd_proxy.log C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234 [2025-06-19T19:11:45.983Z] STF 19:11:45.650 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/2.CL1.stderr [2025-06-19T19:11:45.983Z] STF 19:11:45.650 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/2.CL1.stdout [2025-06-19T19:11:45.983Z] STF 19:11:45.655 - [2025-06-19T19:11:45.983Z] STF 19:11:45.655 - +------ Step 3 - Wait for processes to complete [2025-06-19T19:11:45.983Z] STF 19:11:45.655 - | Wait for processes to meet expectations [2025-06-19T19:11:45.983Z] STF 19:11:45.655 - | Processes: [LT1, CL1] [2025-06-19T19:11:45.983Z] STF 19:11:45.655 - | [2025-06-19T19:11:45.983Z] STF 19:11:45.655 - Monitoring processes: CL1 LT1 [2025-06-19T19:11:46.979Z] CL1 j> 2025/06/19 19:11:46.123 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi [2025-06-19T19:11:46.979Z] CL1 j> 2025/06/19 19:11:46.491 Attempting to connect [2025-06-19T19:11:47.306Z] CL1 j> 2025/06/19 19:11:47.148 Monitored VM not ready at Jun 19, 2025, 7:11:47 PM (attempt 1, elapsed 634ms). [2025-06-19T19:11:47.306Z] CL1 j> 2025/06/19 19:11:47.148 Waiting 5 secs and trying again... [2025-06-19T19:12:00.268Z] CL1 j> 2025/06/19 19:11:52.852 Attempting to connect [2025-06-19T19:12:05.085Z] CL1 j> 2025/06/19 19:12:03.158 Connection established! [2025-06-19T19:12:05.085Z] CL1 j> 2025/06/19 19:12:03.307 Starting to write data [2025-06-19T19:17:02.645Z] STF 19:16:45.077 - Heartbeat: Process CL1 is still running [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - Monitoring Report Summary: [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - o Process CL1 ended with the expected exit code (0) [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - o Process LT1 is still running as expected [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - +------ Step 4 - Stop LT1 process [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - | Kill running processes [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - | Processes: [LT1] [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - | [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - Killing processes: LT1 [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - o Process clean up attempt 1 for LT1 pid 41128 [2025-06-19T19:17:58.204Z] STF 19:17:56.686 - o Process LT1 pid 41128 stop() [2025-06-19T19:17:58.204Z] STF 19:17:56.687 - o Process LT1 pid 41128 killed [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - +------ Step 5 - Running ThreadProfiler Server test Server Process(without security) [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - | Start background process [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - | Program: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - | Mnemonic: LT2 [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - | Echo: ECHO_OFF [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - | Expectation: NEVER [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - | [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - Running command: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -javaagent:C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jvmtest/system/STF/stf.core/scripts/../../stf.load/bin/stf.load.jar -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_openjdk11_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.load\bin;C:\jenkins\workspace\Test_openjdk11_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/asm/asm.jar;c:/jenkins/testDependency/system_lib/asm/asm-commons.jar;c:/jenkins/testDependency/system_lib/junit/junit.jar;c:/jenkins/testDependency/system_lib/junit/hamcrest-core.jar;C:\jenkins\workspace\Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.lang\bin;C:\jenkins\workspace\Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.util\bin;C:\jenkins\workspace\Test_openjdk11_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_openjdk11_hs_sanity.system_x86-64_windows_testList_0\aqa-tests\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0\20250619-191142-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_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-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 [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/5.LT2.stderr [2025-06-19T19:17:58.204Z] STF 19:17:56.688 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/5.LT2.stdout [2025-06-19T19:17:58.204Z] STF 19:17:56.697 - [2025-06-19T19:17:58.205Z] STF 19:17:56.697 - +------ Step 6 - Running the Monitoring Client with server-connection(without security) [2025-06-19T19:17:58.205Z] STF 19:17:56.697 - | Start background process [2025-06-19T19:17:58.205Z] STF 19:17:56.697 - | Program: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-06-19T19:17:58.205Z] STF 19:17:56.697 - | Mnemonic: CL2 [2025-06-19T19:17:58.205Z] STF 19:17:56.697 - | Echo: ECHO_ON [2025-06-19T19:17:58.205Z] STF 19:17:56.697 - | Expectation: CLEAN_RUN within 30m [2025-06-19T19:17:58.205Z] STF 19:17:56.697 - | [2025-06-19T19:17:58.205Z] STF 19:17:56.698 - Running command: c:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:+UseCompressedOops -classpath C:\jenkins\workspace\Test_openjdk11_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_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/thd_proxy.log C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234 [2025-06-19T19:17:58.205Z] STF 19:17:56.698 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/6.CL2.stderr [2025-06-19T19:17:58.205Z] STF 19:17:56.698 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17503595188227/TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/results/6.CL2.stdout [2025-06-19T19:17:58.205Z] STF 19:17:56.703 - [2025-06-19T19:17:58.205Z] STF 19:17:56.704 - +------ Step 7 - Wait for processes to complete [2025-06-19T19:17:58.205Z] STF 19:17:56.704 - | Wait for processes to meet expectations [2025-06-19T19:17:58.205Z] STF 19:17:56.704 - | Processes: [LT2, CL2] [2025-06-19T19:17:58.205Z] STF 19:17:56.704 - | [2025-06-19T19:17:58.205Z] STF 19:17:56.704 - Monitoring processes: CL2 LT2 [2025-06-19T19:17:58.205Z] CL2 j> 2025/06/19 19:17:57.184 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi [2025-06-19T19:17:58.205Z] CL2 j> 2025/06/19 19:17:57.501 Attempting to connect [2025-06-19T19:17:58.890Z] CL2 j> 2025/06/19 19:17:58.176 Monitored VM not ready at Jun 19, 2025, 7:17:58 PM (attempt 1, elapsed 653ms). [2025-06-19T19:17:58.890Z] CL2 j> 2025/06/19 19:17:58.176 Waiting 5 secs and trying again... [2025-06-19T19:18:09.160Z] CL2 j> 2025/06/19 19:18:03.961 Attempting to connect [2025-06-19T19:18:16.860Z] CL2 j> 2025/06/19 19:18:11.990 Connection established! [2025-06-19T19:18:36.473Z] CL2 j> 2025/06/19 19:18:27.358 Writing report data ... [2025-06-19T19:18:36.473Z] CL2 j> 2025/06/19 19:18:30.459 done. [2025-06-19T19:18:49.369Z] CL2 j> 2025/06/19 19:18:41.180 Writing report data ... [2025-06-19T19:18:49.369Z] CL2 j> 2025/06/19 19:18:43.486 done. [2025-06-19T19:18:59.416Z] CL2 j> 2025/06/19 19:18:54.593 Writing report data ... [2025-06-19T19:18:59.416Z] CL2 j> 2025/06/19 19:18:55.621 done. [2025-06-19T19:19:08.967Z] CL2 j> 2025/06/19 19:19:06.478 Writing report data ... [2025-06-19T19:19:08.967Z] CL2 j> 2025/06/19 19:19:07.187 done. [2025-06-19T19:19:24.053Z] CL2 j> 2025/06/19 19:19:19.525 Writing report data ... [2025-06-19T19:19:24.053Z] CL2 j> 2025/06/19 19:19:20.889 done. [2025-06-19T19:19:36.710Z] CL2 j> 2025/06/19 19:19:32.575 Writing report data ... [2025-06-19T19:19:38.685Z] CL2 j> 2025/06/19 19:19:34.242 done. [2025-06-19T19:19:46.032Z] CL2 j> 2025/06/19 19:19:45.463 Writing report data ... [2025-06-19T19:19:47.319Z] CL2 j> 2025/06/19 19:19:46.092 done. [2025-06-19T19:19:59.186Z] CL2 j> 2025/06/19 19:19:57.538 Writing report data ... [2025-06-19T19:19:59.186Z] CL2 j> 2025/06/19 19:19:58.354 done. [2025-06-19T19:20:13.129Z] CL2 j> 2025/06/19 19:20:09.836 Writing report data ... [2025-06-19T19:20:14.490Z] CL2 j> 2025/06/19 19:20:10.986 done. [2025-06-19T19:20:31.223Z] CL2 j> 2025/06/19 19:20:22.900 Writing report data ... [2025-06-19T19:20:31.223Z] CL2 j> 2025/06/19 19:20:23.719 done. [2025-06-19T19:20:45.221Z] CL2 j> 2025/06/19 19:20:35.453 Writing report data ... [2025-06-19T19:20:45.221Z] CL2 j> 2025/06/19 19:20:36.699 done. [2025-06-19T19:20:51.917Z] CL2 j> 2025/06/19 19:20:48.674 Writing report data ... [2025-06-19T19:20:52.536Z] CL2 j> 2025/06/19 19:20:49.534 done. [2025-06-19T19:21:06.607Z] CL2 j> 2025/06/19 19:21:01.102 Writing report data ... [2025-06-19T19:21:06.607Z] CL2 j> 2025/06/19 19:21:01.327 done. [2025-06-19T19:21:16.423Z] CL2 j> 2025/06/19 19:21:12.060 Writing report data ... [2025-06-19T19:21:20.030Z] CL2 j> 2025/06/19 19:21:12.491 done. [2025-06-19T19:21:33.569Z] CL2 j> 2025/06/19 19:21:24.431 Writing report data ... [2025-06-19T19:21:33.569Z] CL2 j> 2025/06/19 19:21:24.982 done. [2025-06-19T19:21:39.587Z] CL2 j> 2025/06/19 19:21:38.127 Writing report data ... [2025-06-19T19:21:41.368Z] CL2 j> 2025/06/19 19:21:39.180 done. [2025-06-19T19:21:46.922Z] STF 19:21:45.480 - Heartbeat: Process CL2 is still running [2025-06-19T19:21:54.735Z] CL2 j> 2025/06/19 19:21:49.643 Writing report data ... [2025-06-19T19:21:54.735Z] CL2 j> 2025/06/19 19:21:50.446 done. [2025-06-19T19:22:08.271Z] CL2 j> 2025/06/19 19:22:01.136 Writing report data ... [2025-06-19T19:22:08.271Z] CL2 j> 2025/06/19 19:22:01.404 done. [2025-06-19T19:22:19.761Z] CL2 j> 2025/06/19 19:22:13.392 Writing report data ... [2025-06-19T19:22:19.761Z] CL2 j> 2025/06/19 19:22:13.726 done. [2025-06-19T19:22:31.388Z] CL2 j> 2025/06/19 19:22:25.253 Writing report data ... [2025-06-19T19:22:31.388Z] CL2 j> 2025/06/19 19:22:25.706 done. [2025-06-19T19:22:41.473Z] CL2 j> 2025/06/19 19:22:36.932 Writing report data ... [2025-06-19T19:22:41.473Z] CL2 j> 2025/06/19 19:22:37.288 done. [2025-06-19T19:22:57.202Z] CL2 j> 2025/06/19 19:22:48.176 Writing report data ... [2025-06-19T19:22:57.202Z] CL2 j> 2025/06/19 19:22:48.749 done. [2025-06-19T19:23:02.511Z] CL2 j> 2025/06/19 19:23:00.463 Writing report data ... [2025-06-19T19:23:02.511Z] CL2 j> 2025/06/19 19:23:00.667 done. [2025-06-19T19:23:18.595Z] CL2 j> 2025/06/19 19:23:11.927 Writing report data ... [2025-06-19T19:23:18.595Z] CL2 j> 2025/06/19 19:23:12.904 done. [2025-06-19T19:23:29.690Z] CL2 j> 2025/06/19 19:23:24.106 Writing report data ... [2025-06-19T19:23:29.690Z] CL2 j> 2025/06/19 19:23:24.326 done. [2025-06-19T19:23:41.002Z] CL2 j> 2025/06/19 19:23:34.946 Writing report data ... [2025-06-19T19:23:42.860Z] CL2 j> 2025/06/19 19:23:35.800 done. [2025-06-19T19:23:53.897Z] CL2 j> 2025/06/19 19:23:46.239 Writing report data ... [2025-06-19T19:23:53.897Z] CL2 j> 2025/06/19 19:23:46.434 done. [2025-06-19T19:24:02.014Z] CL2 j> 2025/06/19 19:23:59.165 Writing report data ... [2025-06-19T19:24:02.014Z] CL2 j> 2025/06/19 19:23:59.359 done. [2025-06-19T19:24:13.391Z] CL2 j> 2025/06/19 19:24:10.404 Writing report data ... [2025-06-19T19:24:16.908Z] CL2 j> 2025/06/19 19:24:12.062 done. [2025-06-19T19:24:26.763Z] CL2 j> 2025/06/19 19:24:22.870 Writing report data ... [2025-06-19T19:24:26.763Z] CL2 j> 2025/06/19 19:24:23.433 done. [2025-06-19T19:24:28.534Z] STF 19:24:28.187 - Monitoring Report Summary: [2025-06-19T19:24:28.534Z] STF 19:24:28.187 - o Process CL2 ended with the expected exit code (0) [2025-06-19T19:24:28.534Z] STF 19:24:28.187 - o Process LT2 is still running as expected [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - +------ Step 8 - Stop LT2 process [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - | Kill running processes [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - | Processes: [LT2] [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - | [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - Killing processes: LT2 [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - o Process clean up attempt 1 for LT2 pid 884 [2025-06-19T19:24:28.534Z] STF 19:24:28.188 - o Process LT2 pid 884 stop() [2025-06-19T19:24:28.534Z] STF 19:24:28.190 - o Process LT2 pid 884 killed [2025-06-19T19:24:28.534Z] STF 19:24:28.190 - EXECUTE stage completed [2025-06-19T19:24:28.534Z] STF 19:24:28.255 - [2025-06-19T19:24:28.534Z] STF 19:24:28.255 - ==================== T E A R D O W N ==================== [2025-06-19T19:24:28.534Z] STF 19:24:28.255 - Running teardown: perl C:/jenkins/workspace/Test_openjdk11_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17503595188227\TestJlmRemoteThreadNoAuth_0/20250619-191142-TestJlmRemoteThreadNoAuth/tearDown.pl [2025-06-19T19:24:28.534Z] STF 19:24:28.454 - TEARDOWN stage completed [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - ===================== R E S U L T S ===================== [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - Stage results: [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - setUp: pass [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - execute: pass [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - teardown: pass [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - [2025-06-19T19:24:28.534Z] STF 19:24:28.483 - Overall result: PASSED [2025-06-19T19:24:28.850Z] ----------------------------------- [2025-06-19T19:24:28.850Z] TestJlmRemoteThreadNoAuth_0_PASSED [2025-06-19T19:24:28.850Z] ----------------------------------- [2025-06-19T19:24:28.850Z] [2025-06-19T19:24:28.850Z] TEST TEARDOWN: [2025-06-19T19:24:28.850Z] Nothing to be done for teardown. [2025-06-19T19:24:29.159Z] TestJlmRemoteThreadNoAuth_0 Finish Time: Thu Jun 19 19:24:28 2025 Epoch Time (ms): 1750361068965