[2025-12-16T09:18:53.275Z] Running test TestJlmRemoteThreadNoAuth_1 ... [2025-12-16T09:18:53.275Z] =============================================== [2025-12-16T09:18:53.275Z] TestJlmRemoteThreadNoAuth_1 Start Time: Tue Dec 16 09:18:51 2025 Epoch Time (ms): 1765876731504 [2025-12-16T09:18:53.275Z] variation: Mode650 [2025-12-16T09:18:53.275Z] JVM_OPTIONS: -XX:-UseCompressedOops [2025-12-16T09:18:53.275Z] { \ [2025-12-16T09:18:53.275Z] echo ""; echo "TEST SETUP:"; \ [2025-12-16T09:18:53.275Z] echo "Nothing to be done for setup."; \ [2025-12-16T09:18:53.275Z] mkdir -p "C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17658760134559\\TestJlmRemoteThreadNoAuth_1"; \ [2025-12-16T09:18:53.275Z] cd "C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17658760134559\\TestJlmRemoteThreadNoAuth_1"; \ [2025-12-16T09:18:53.275Z] echo ""; echo "TESTING:"; \ [2025-12-16T09:18:53.275Z] perl C:/jenkins/workspace/Test_openjdk25_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_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests///..//jvmtest\\system\\jlm/../\\STF;C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests///..//jvmtest\\system\\jlm/../\\aqa-systemtest""" -systemtest-prereqs="c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/../../externalDependency/system_lib\\" -java-args=' -XX:-UseCompressedOops ' -results-root="C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17658760134559\\TestJlmRemoteThreadNoAuth_1" -test=TestJlmRemoteThreadNoAuth; \ [2025-12-16T09:18:53.275Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_1""_PASSED"; echo "-----------------------------------"; cd C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/; rm -f -r "C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17658760134559\\TestJlmRemoteThreadNoAuth_1"; else echo "-----------------------------------"; echo "TestJlmRemoteThreadNoAuth_1""_FAILED"; echo "-----------------------------------"; fi; \ [2025-12-16T09:18:53.275Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-12-16T09:18:53.275Z] echo "Nothing to be done for teardown."; \ [2025-12-16T09:18:53.275Z] } 2>&1 | tee -a "C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\\TKG\\output_17658760134559\\TestTargetResult"; [2025-12-16T09:18:53.275Z] [2025-12-16T09:18:53.275Z] TEST SETUP: [2025-12-16T09:18:53.275Z] Nothing to be done for setup. [2025-12-16T09:18:53.275Z] [2025-12-16T09:18:53.275Z] TESTING: [2025-12-16T09:18:53.275Z] STF 09:18:51.930 - ========================= S T F ========================= [2025-12-16T09:18:53.275Z] systemtest-prereqs has been processed, and set to: c:/jenkins/externalDependency/system_libRetrieving amount of free space on drive containing C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1 [2025-12-16T09:18:53.275Z] There is 121844 Mb free [2025-12-16T09:18:53.275Z] STF 09:18:51.984 - ================== G E N E R A T I O N ================== [2025-12-16T09:18:53.275Z] STF 09:18:51.986 - Checking JVM: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image [2025-12-16T09:18:53.275Z] STF 09:18:51.987 - Starting process to generate scripts: c:/jenkins/workspace/Test_openjdk25_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_openjdk25_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_openjdk25_hs_sanity.system_x86-64_windows_testList_0/../../externalDependency/system_lib\/asm/asm.jar;c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/../../externalDependency/system_lib\/asm/asm-commons.jar;c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/../../externalDependency/system_lib\/log4j/log4j-api.jar;c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/../../externalDependency/system_lib\/log4j/log4j-core.jar;C:/jenkins/workspace/Test_openjdk25_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_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/stf_parameters.properties, , C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jvmtest/system/STF/stf.core/config/stf.properties" -testDir "C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth" [2025-12-16T09:18:53.275Z] GEN [0.016s][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 [2025-12-16T09:18:53.275Z] GEN 09:18:52.921 - Found test. Project: 'openjdk.test.jlm' class: 'TestJlmRemoteThreadNoAuth.class' Dir: 'C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.jlm\bin' [2025-12-16T09:18:53.275Z] GEN 09:18:52.958 - Found test. Project: 'openjdk.test.jlm' class: 'net.adoptopenjdk.test.jlm.TestJlmRemoteThreadNoAuth' [2025-12-16T09:18:53.276Z] GEN Classpath directories used by project 'openjdk.test.jlm': [2025-12-16T09:18:53.276Z] GEN C:\\jenkins\\workspace\\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\\jvmtest\\system\\aqa-systemtest\\openjdk.test.jlm\\bin [2025-12-16T09:18:53.276Z] GEN C:\\jenkins\\workspace\\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\\jvmtest\\system\\STF\\stf.core\\bin [2025-12-16T09:18:53.276Z] GEN c:/jenkins/externalDependency/system_lib/log4j/log4j-api.jar [2025-12-16T09:18:53.276Z] GEN c:/jenkins/externalDependency/system_lib/log4j/log4j-core.jar [2025-12-16T09:18:53.276Z] GEN c:/jenkins/externalDependency/system_lib/junit/junit.jar [2025-12-16T09:18:53.276Z] GEN 09:18:53.134 - Using Mode NoOptions. Values = '' [2025-12-16T09:18:53.625Z] GEN 09:18:53.257 - [2025-12-16T09:18:53.625Z] GEN 09:18:53.257 - Test command summary: [2025-12-16T09:18:53.625Z] GEN 09:18:53.258 - Step Stage Command Description [2025-12-16T09:18:53.625Z] GEN 09:18:53.258 - -----+--------+-----------------+------------ [2025-12-16T09:18:53.625Z] GEN 09:18:53.258 - 1 execute Run java Running ThreadProfiler Proxy test Server Process [2025-12-16T09:18:53.625Z] GEN 09:18:53.258 - 2 execute Run java Running the monitoring Client with proxy connection(without security) [2025-12-16T09:18:53.625Z] GEN 09:18:53.258 - 3 execute Monitor Wait for processes to complete [2025-12-16T09:18:53.625Z] GEN 09:18:53.258 - 4 execute kill Stop LT1 process [2025-12-16T09:18:53.625Z] GEN 09:18:53.258 - 5 execute Run java Running ThreadProfiler Server test Server Process(without security) [2025-12-16T09:18:53.625Z] GEN 09:18:53.259 - 6 execute Run java Running the Monitoring Client with server-connection(without security) [2025-12-16T09:18:53.625Z] GEN 09:18:53.259 - 7 execute Monitor Wait for processes to complete [2025-12-16T09:18:53.625Z] GEN 09:18:53.259 - 8 execute kill Stop LT2 process [2025-12-16T09:18:53.625Z] STF 09:18:53.285 - [2025-12-16T09:18:53.625Z] STF 09:18:53.285 - Script generation completed [2025-12-16T09:18:53.625Z] STF 09:18:53.285 - [2025-12-16T09:18:53.625Z] STF 09:18:53.287 - [2025-12-16T09:18:53.625Z] STF 09:18:53.287 - ======================= S E T U P ======================= [2025-12-16T09:18:53.625Z] STF 09:18:53.287 - Running setup: perl C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/setUp.pl [2025-12-16T09:18:53.625Z] STF 09:18:53.426 - SETUP stage completed [2025-12-16T09:18:53.625Z] STF 09:18:53.445 - [2025-12-16T09:18:53.625Z] STF 09:18:53.445 - ==================== E X E C U T E - ==================== [2025-12-16T09:18:53.625Z] STF 09:18:53.445 - Running execute: perl C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/execute.pl [2025-12-16T09:18:53.983Z] STF 09:18:53.585 - [2025-12-16T09:18:53.983Z] STF 09:18:53.585 - Java version [2025-12-16T09:18:53.983Z] STF 09:18:53.585 - Running: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -version [2025-12-16T09:18:53.983Z] openjdk version "25.0.3-beta" 2026-04-21 [2025-12-16T09:18:53.983Z] OpenJDK Runtime Environment Temurin-25.0.3+0-202512151231 (build 25.0.3-beta-202512151231) [2025-12-16T09:18:53.983Z] OpenJDK 64-Bit Server VM Temurin-25.0.3+0-202512151231 (build 25.0.3-beta-202512151231, mixed mode, sharing) [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - +------ Step 1 - Running ThreadProfiler Proxy test Server Process [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - | Start background process [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - | Program: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - | Mnemonic: LT1 [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - | Echo: ECHO_OFF [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - | Expectation: NEVER [2025-12-16T09:18:53.983Z] STF 09:18:53.660 - | [2025-12-16T09:18:53.983Z] STF 09:18:53.661 - Running command: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -javaagent:C:/jenkins/workspace/Test_openjdk25_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_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.load\bin;C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.core\bin;c:/jenkins/externalDependency/system_lib/log4j/log4j-api.jar;c:/jenkins/externalDependency/system_lib/log4j/log4j-core.jar;c:/jenkins/externalDependency/system_lib/asm/asm.jar;c:/jenkins/externalDependency/system_lib/asm/asm-commons.jar;c:/jenkins/externalDependency/system_lib/junit/junit.jar;c:/jenkins/externalDependency/system_lib/junit/hamcrest-core.jar;C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.lang\bin;C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.util\bin;C:\jenkins\workspace\Test_openjdk25_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_openjdk25_hs_sanity.system_x86-64_windows_testList_0\aqa-tests\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1\20251216-091851-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_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/1.LT1.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-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-12-16T09:18:53.983Z] STF 09:18:53.661 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/1.LT1.stderr [2025-12-16T09:18:53.983Z] STF 09:18:53.661 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/1.LT1.stdout [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - +------ Step 2 - Running the monitoring Client with proxy connection(without security) [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - | Start background process [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - | Program: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - | Mnemonic: CL1 [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - | Echo: ECHO_ON [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - | Expectation: CLEAN_RUN within 30m [2025-12-16T09:18:53.983Z] STF 09:18:53.692 - | [2025-12-16T09:18:53.984Z] STF 09:18:53.693 - Running command: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:-UseCompressedOops -classpath C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.jlm\bin;c:/jenkins/externalDependency/system_lib/junit/junit.jar net.adoptopenjdk.test.jlm.remote.ThreadProfiler proxy C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/thd_proxy.log C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234 [2025-12-16T09:18:53.984Z] STF 09:18:53.693 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/2.CL1.stderr [2025-12-16T09:18:53.984Z] STF 09:18:53.693 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/2.CL1.stdout [2025-12-16T09:18:53.984Z] STF 09:18:53.699 - [2025-12-16T09:18:53.984Z] STF 09:18:53.699 - +------ Step 3 - Wait for processes to complete [2025-12-16T09:18:53.984Z] STF 09:18:53.699 - | Wait for processes to meet expectations [2025-12-16T09:18:53.984Z] STF 09:18:53.699 - | Processes: [LT1, CL1] [2025-12-16T09:18:53.984Z] STF 09:18:53.699 - | [2025-12-16T09:18:53.984Z] STF 09:18:53.699 - Monitoring processes: CL1 LT1 [2025-12-16T09:18:54.345Z] CL1 j> 2025/12/16 09:18:53.849 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi [2025-12-16T09:18:54.345Z] CL1 j> 2025/12/16 09:18:53.923 Attempting to connect [2025-12-16T09:18:54.345Z] CL1 j> 2025/12/16 09:18:54.127 Monitored VM not ready at Dec 16, 2025, 9:18:54?AM (attempt 1, elapsed 181ms). [2025-12-16T09:18:54.345Z] CL1 j> 2025/12/16 09:18:54.128 Waiting 5 secs and trying again... [2025-12-16T09:19:06.071Z] CL1 j> 2025/12/16 09:18:59.787 Attempting to connect [2025-12-16T09:19:10.029Z] CL1 j> 2025/12/16 09:19:04.755 Connection established! [2025-12-16T09:19:10.029Z] CL1 j> 2025/12/16 09:19:08.395 Starting to write data [2025-12-16T09:23:54.354Z] STF 09:23:53.050 - Heartbeat: Process LT1 is still running [2025-12-16T09:24:44.499Z] STF 09:24:42.812 - Monitoring Report Summary: [2025-12-16T09:24:44.499Z] STF 09:24:42.812 - o Process CL1 ended with the expected exit code (0) [2025-12-16T09:24:44.499Z] STF 09:24:42.862 - o Process LT1 is still running as expected [2025-12-16T09:24:44.499Z] STF 09:24:42.956 - [2025-12-16T09:24:44.499Z] STF 09:24:42.960 - +------ Step 4 - Stop LT1 process [2025-12-16T09:24:44.499Z] STF 09:24:42.960 - | Kill running processes [2025-12-16T09:24:44.499Z] STF 09:24:42.960 - | Processes: [LT1] [2025-12-16T09:24:44.499Z] STF 09:24:42.960 - | [2025-12-16T09:24:44.499Z] STF 09:24:42.960 - Killing processes: LT1 [2025-12-16T09:24:44.499Z] STF 09:24:42.960 - o Process clean up attempt 1 for LT1 pid 404 [2025-12-16T09:24:44.499Z] STF 09:24:42.960 - o Process LT1 pid 404 stop() [2025-12-16T09:24:44.499Z] STF 09:24:42.961 - o Process LT1 pid 404 killed [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - +------ Step 5 - Running ThreadProfiler Server test Server Process(without security) [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - | Start background process [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - | Program: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - | Mnemonic: LT2 [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - | Echo: ECHO_OFF [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - | Expectation: NEVER [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - | [2025-12-16T09:24:44.499Z] STF 09:24:42.962 - Running command: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -javaagent:C:/jenkins/workspace/Test_openjdk25_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_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.load\bin;C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\STF\stf.core\bin;c:/jenkins/externalDependency/system_lib/log4j/log4j-api.jar;c:/jenkins/externalDependency/system_lib/log4j/log4j-core.jar;c:/jenkins/externalDependency/system_lib/asm/asm.jar;c:/jenkins/externalDependency/system_lib/asm/asm-commons.jar;c:/jenkins/externalDependency/system_lib/junit/junit.jar;c:/jenkins/externalDependency/system_lib/junit/hamcrest-core.jar;C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.lang\bin;C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.util\bin;C:\jenkins\workspace\Test_openjdk25_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_openjdk25_hs_sanity.system_x86-64_windows_testList_0\aqa-tests\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1\20251216-091851-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_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/5.LT2.inventory/openjdk.test.load/config/inventories/mix/mini-mix_exclude.xml -suite.mini-mix.inventoryExcludeFile C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-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-12-16T09:24:44.499Z] STF 09:24:42.963 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/5.LT2.stderr [2025-12-16T09:24:44.499Z] STF 09:24:42.963 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/5.LT2.stdout [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - +------ Step 6 - Running the Monitoring Client with server-connection(without security) [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - | Start background process [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - | Program: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - | Mnemonic: CL2 [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - | Echo: ECHO_ON [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - | Expectation: CLEAN_RUN within 30m [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - | [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - Running command: c:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/jdkbinary/j2sdk-image/bin/java -Xmx256m -XX:-UseCompressedOops -classpath C:\jenkins\workspace\Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0\jvmtest\system\aqa-systemtest\openjdk.test.jlm\bin;c:/jenkins/externalDependency/system_lib/junit/junit.jar net.adoptopenjdk.test.jlm.remote.ThreadProfiler server C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/thd_proxy.log C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/thd_proxy.csv anon localhost 1234 [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - Redirecting stderr to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/6.CL2.stderr [2025-12-16T09:24:44.499Z] STF 09:24:42.971 - Redirecting stdout to C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/TKG/output_17658760134559/TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/results/6.CL2.stdout [2025-12-16T09:24:44.499Z] STF 09:24:42.977 - [2025-12-16T09:24:44.499Z] STF 09:24:42.977 - +------ Step 7 - Wait for processes to complete [2025-12-16T09:24:44.499Z] STF 09:24:42.977 - | Wait for processes to meet expectations [2025-12-16T09:24:44.499Z] STF 09:24:42.977 - | Processes: [LT2, CL2] [2025-12-16T09:24:44.499Z] STF 09:24:42.977 - | [2025-12-16T09:24:44.499Z] STF 09:24:42.977 - Monitoring processes: CL2 LT2 [2025-12-16T09:24:44.499Z] CL2 j> 2025/12/16 09:24:43.162 ServerURL=service:jmx:rmi:///jndi/rmi://localhost:1234/jmxrmi [2025-12-16T09:24:44.499Z] CL2 j> 2025/12/16 09:24:43.237 Attempting to connect [2025-12-16T09:24:44.499Z] CL2 j> 2025/12/16 09:24:43.438 Monitored VM not ready at Dec 16, 2025, 9:24:43?AM (attempt 1, elapsed 176ms). [2025-12-16T09:24:44.499Z] CL2 j> 2025/12/16 09:24:43.439 Waiting 5 secs and trying again... [2025-12-16T09:24:53.190Z] CL2 j> 2025/12/16 09:24:49.258 Attempting to connect [2025-12-16T09:24:59.231Z] CL2 j> 2025/12/16 09:24:51.610 Connection established! [2025-12-16T09:25:09.044Z] CL2 j> 2025/12/16 09:25:03.781 Writing report data ... [2025-12-16T09:25:18.920Z] CL2 j> 2025/12/16 09:25:13.008 done. [2025-12-16T09:25:28.970Z] CL2 j> 2025/12/16 09:25:23.958 Writing report data ... [2025-12-16T09:25:28.971Z] CL2 j> 2025/12/16 09:25:25.434 done. [2025-12-16T09:25:41.243Z] CL2 j> 2025/12/16 09:25:36.177 Writing report data ... [2025-12-16T09:25:41.243Z] CL2 j> 2025/12/16 09:25:37.234 done. [2025-12-16T09:25:53.225Z] CL2 j> 2025/12/16 09:25:48.487 Writing report data ... [2025-12-16T09:25:55.274Z] CL2 j> 2025/12/16 09:25:51.201 done. [2025-12-16T09:26:05.279Z] CL2 j> 2025/12/16 09:26:01.544 Writing report data ... [2025-12-16T09:26:06.867Z] CL2 j> 2025/12/16 09:26:02.821 done. [2025-12-16T09:26:15.344Z] CL2 j> 2025/12/16 09:26:13.176 Writing report data ... [2025-12-16T09:26:17.556Z] CL2 j> 2025/12/16 09:26:13.578 done. [2025-12-16T09:26:29.694Z] CL2 j> 2025/12/16 09:26:24.079 Writing report data ... [2025-12-16T09:26:29.694Z] CL2 j> 2025/12/16 09:26:24.921 done. [2025-12-16T09:26:37.994Z] CL2 j> 2025/12/16 09:26:35.279 Writing report data ... [2025-12-16T09:26:40.712Z] CL2 j> 2025/12/16 09:26:35.971 done. [2025-12-16T09:26:51.119Z] CL2 j> 2025/12/16 09:26:46.316 Writing report data ... [2025-12-16T09:26:51.119Z] CL2 j> 2025/12/16 09:26:47.275 done. [2025-12-16T09:27:01.098Z] CL2 j> 2025/12/16 09:26:57.512 Writing report data ... [2025-12-16T09:27:02.627Z] CL2 j> 2025/12/16 09:26:58.851 done. [2025-12-16T09:27:12.743Z] CL2 j> 2025/12/16 09:27:09.809 Writing report data ... [2025-12-16T09:27:14.223Z] CL2 j> 2025/12/16 09:27:11.119 done. [2025-12-16T09:27:24.463Z] CL2 j> 2025/12/16 09:27:21.570 Writing report data ... [2025-12-16T09:27:28.126Z] CL2 j> 2025/12/16 09:27:24.327 done. [2025-12-16T09:27:38.051Z] CL2 j> 2025/12/16 09:27:34.594 Writing report data ... [2025-12-16T09:27:40.813Z] CL2 j> 2025/12/16 09:27:35.986 done. [2025-12-16T09:27:50.887Z] CL2 j> 2025/12/16 09:27:46.477 Writing report data ... [2025-12-16T09:27:52.289Z] CL2 j> 2025/12/16 09:27:47.213 done. [2025-12-16T09:28:00.921Z] CL2 j> 2025/12/16 09:27:57.844 Writing report data ... [2025-12-16T09:28:03.161Z] CL2 j> 2025/12/16 09:27:59.411 done. [2025-12-16T09:28:15.276Z] CL2 j> 2025/12/16 09:28:09.804 Writing report data ... [2025-12-16T09:28:15.276Z] CL2 j> 2025/12/16 09:28:11.192 done. [2025-12-16T09:28:23.452Z] CL2 j> 2025/12/16 09:28:21.469 Writing report data ... [2025-12-16T09:28:26.323Z] CL2 j> 2025/12/16 09:28:22.216 done. [2025-12-16T09:28:38.381Z] CL2 j> 2025/12/16 09:28:33.152 Writing report data ... [2025-12-16T09:28:39.287Z] CL2 j> 2025/12/16 09:28:34.894 done. [2025-12-16T09:28:48.385Z] CL2 j> 2025/12/16 09:28:45.313 Writing report data ... [2025-12-16T09:28:50.476Z] CL2 j> 2025/12/16 09:28:45.838 done. [2025-12-16T09:28:56.271Z] STF 09:28:53.006 - Heartbeat: Process LT2 is still running [2025-12-16T09:29:02.076Z] CL2 j> 2025/12/16 09:28:56.373 Writing report data ... [2025-12-16T09:29:02.618Z] CL2 j> 2025/12/16 09:28:57.818 done. [2025-12-16T09:29:12.762Z] CL2 j> 2025/12/16 09:29:08.195 Writing report data ... [2025-12-16T09:29:16.406Z] CL2 j> 2025/12/16 09:29:10.356 done. [2025-12-16T09:29:27.500Z] CL2 j> 2025/12/16 09:29:21.470 Writing report data ... [2025-12-16T09:29:27.500Z] CL2 j> 2025/12/16 09:29:23.197 done. [2025-12-16T09:29:39.649Z] CL2 j> 2025/12/16 09:29:33.595 Writing report data ... [2025-12-16T09:29:39.649Z] CL2 j> 2025/12/16 09:29:35.084 done. [2025-12-16T09:29:51.944Z] CL2 j> 2025/12/16 09:29:45.371 Writing report data ... [2025-12-16T09:29:51.944Z] CL2 j> 2025/12/16 09:29:46.411 done. [2025-12-16T09:30:00.041Z] CL2 j> 2025/12/16 09:29:56.847 Writing report data ... [2025-12-16T09:30:02.334Z] CL2 j> 2025/12/16 09:29:57.383 done. [2025-12-16T09:30:10.705Z] CL2 j> 2025/12/16 09:30:07.623 Writing report data ... [2025-12-16T09:30:10.705Z] CL2 j> 2025/12/16 09:30:09.200 done. [2025-12-16T09:30:25.215Z] CL2 j> 2025/12/16 09:30:19.547 Writing report data ... [2025-12-16T09:30:25.215Z] CL2 j> 2025/12/16 09:30:20.134 done. [2025-12-16T09:30:33.542Z] CL2 j> 2025/12/16 09:30:30.309 Writing report data ... [2025-12-16T09:30:38.059Z] CL2 j> 2025/12/16 09:30:33.750 done. [2025-12-16T09:30:48.191Z] CL2 j> 2025/12/16 09:30:44.182 Writing report data ... [2025-12-16T09:30:48.191Z] CL2 j> 2025/12/16 09:30:44.868 done. [2025-12-16T09:30:58.636Z] CL2 j> 2025/12/16 09:30:55.255 Writing report data ... [2025-12-16T09:30:59.511Z] CL2 j> 2025/12/16 09:30:55.797 done. [2025-12-16T09:30:59.511Z] STF 09:30:58.905 - Monitoring Report Summary: [2025-12-16T09:30:59.511Z] STF 09:30:58.906 - o Process CL2 ended with the expected exit code (0) [2025-12-16T09:30:59.511Z] STF 09:30:58.906 - o Process LT2 is still running as expected [2025-12-16T09:30:59.511Z] STF 09:30:59.037 - [2025-12-16T09:30:59.511Z] STF 09:30:59.091 - +------ Step 8 - Stop LT2 process [2025-12-16T09:30:59.511Z] STF 09:30:59.093 - | Kill running processes [2025-12-16T09:30:59.511Z] STF 09:30:59.093 - | Processes: [LT2] [2025-12-16T09:30:59.511Z] STF 09:30:59.093 - | [2025-12-16T09:30:59.511Z] STF 09:30:59.093 - Killing processes: LT2 [2025-12-16T09:30:59.511Z] STF 09:30:59.147 - o Process clean up attempt 1 for LT2 pid 1092 [2025-12-16T09:30:59.511Z] STF 09:30:59.149 - o Process LT2 pid 1092 stop() [2025-12-16T09:30:59.511Z] STF 09:30:59.265 - o Process LT2 pid 1092 killed [2025-12-16T09:30:59.511Z] STF 09:30:59.265 - EXECUTE stage completed [2025-12-16T09:30:59.857Z] STF 09:30:59.801 - [2025-12-16T09:30:59.857Z] STF 09:30:59.801 - ==================== T E A R D O W N ==================== [2025-12-16T09:30:59.857Z] STF 09:30:59.801 - Running teardown: perl C:/jenkins/workspace/Test_openjdk25_hs_sanity.system_x86-64_windows_testList_0/aqa-tests/\TKG\output_17658760134559\TestJlmRemoteThreadNoAuth_1/20251216-091851-TestJlmRemoteThreadNoAuth/tearDown.pl [2025-12-16T09:31:00.210Z] STF 09:30:59.949 - TEARDOWN stage completed [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - ===================== R E S U L T S ===================== [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - Stage results: [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - setUp: pass [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - execute: pass [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - teardown: pass [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - [2025-12-16T09:31:00.210Z] STF 09:30:59.970 - Overall result: PASSED [2025-12-16T09:31:00.210Z] ----------------------------------- [2025-12-16T09:31:00.210Z] TestJlmRemoteThreadNoAuth_1_PASSED [2025-12-16T09:31:00.210Z] ----------------------------------- [2025-12-16T09:31:00.210Z] [2025-12-16T09:31:00.210Z] TEST TEARDOWN: [2025-12-16T09:31:00.210Z] Nothing to be done for teardown. [2025-12-16T09:31:00.210Z] TestJlmRemoteThreadNoAuth_1 Finish Time: Tue Dec 16 09:31:00 2025 Epoch Time (ms): 1765877460158