[2025-01-14T09:12:54.523Z] Running test hotspot_serviceability_0 ... [2025-01-14T09:12:54.523Z] =============================================== [2025-01-14T09:12:54.523Z] hotspot_serviceability_0 Start Time: Tue Jan 14 09:12:46 2025 Epoch Time (ms): 1736845966454 [2025-01-14T09:12:54.523Z] variation: NoOptions [2025-01-14T09:12:54.523Z] JVM_OPTIONS: [2025-01-14T09:12:54.523Z] { \ [2025-01-14T09:12:54.523Z] echo ""; echo "TEST SETUP:"; \ [2025-01-14T09:12:54.523Z] echo "Nothing to be done for setup."; \ [2025-01-14T09:12:54.523Z] mkdir -p "C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/\\TKG\\output_1736833830563\\hotspot_serviceability_0"; \ [2025-01-14T09:12:54.523Z] cd "C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/\\TKG\\output_1736833830563\\hotspot_serviceability_0"; \ [2025-01-14T09:12:54.523Z] echo ""; echo "TESTING:"; \ [2025-01-14T09:12:54.523Z] "C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/jdkbinary/j2sdk-image\\bin\\java" -Xmx512m -jar "C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests///..//jvmtest\\openjdk\\jtreg\\lib\\jtreg.jar" \ [2025-01-14T09:12:54.523Z] -agentvm -a -ea -esa -v:fail,error,time,nopass -retain:fail,error,*.dmp,javacore.*,heapdump.*,*.trc -ignore:quiet -timeoutFactor:8 -xml:verify -concurrency:3 -nativepath:"C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows/jdkbinary/openjdk-test-image\\hotspot\\jtreg\\native" -vmoptions:"-Xmx512m " \ [2025-01-14T09:12:54.523Z] -w ""C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/\\TKG\\output_1736833830563\\hotspot_serviceability_0"\\work" \ [2025-01-14T09:12:54.523Z] -r ""C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/\\TKG\\output_1736833830563\\hotspot_serviceability_0"\\report" \ [2025-01-14T09:12:54.523Z] -jdk:"C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/jdkbinary/j2sdk-image" \ [2025-01-14T09:12:54.523Z] -exclude:"C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/\\openjdk\\openjdk-jdk\\test\\hotspot\\jtreg\\ProblemList.txt" \ [2025-01-14T09:12:54.523Z] -exclude:"C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests///..//jvmtest\\openjdk\\excludes/ProblemList_openjdk25.txt" \ [2025-01-14T09:12:54.523Z] \ [2025-01-14T09:12:54.523Z] \ [2025-01-14T09:12:54.523Z] "C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/\\openjdk\\openjdk-jdk\\test\\hotspot\\jtreg:hotspot_serviceability"; \ [2025-01-14T09:12:54.523Z] if [ $? -eq 0 ]; then echo "-----------------------------------"; echo "hotspot_serviceability_0""_PASSED"; echo "-----------------------------------"; cd C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/; else echo "-----------------------------------"; echo "hotspot_serviceability_0""_FAILED"; echo "-----------------------------------"; fi; \ [2025-01-14T09:12:54.523Z] echo ""; echo "TEST TEARDOWN:"; \ [2025-01-14T09:12:54.523Z] echo "Nothing to be done for teardown."; \ [2025-01-14T09:12:54.523Z] } 2>&1 | tee -a "C:/Users/jenkins/workspace/Test_openjdk25_hs_extended.openjdk_aarch64_windows/aqa-tests/\\TKG\\output_1736833830563\\TestTargetResult"; [2025-01-14T09:12:54.523Z] [2025-01-14T09:12:54.523Z] TEST SETUP: [2025-01-14T09:12:54.523Z] Nothing to be done for setup. [2025-01-14T09:12:54.523Z] [2025-01-14T09:12:54.523Z] TESTING: [2025-01-14T09:12:54.523Z] Directory "C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work" not found: creating [2025-01-14T09:12:54.523Z] Directory "C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\report" not found: creating [2025-01-14T09:12:54.825Z] XML output with verification to C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work [2025-01-14T09:19:48.518Z] -------------------------------------------------- [2025-01-14T09:19:48.519Z] TEST: serviceability/jvmti/vthread/ToggleNotifyJvmtiTest/ToggleNotifyJvmtiTest.java [2025-01-14T09:19:48.519Z] TEST JDK: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image [2025-01-14T09:19:48.519Z] [2025-01-14T09:19:48.519Z] ACTION: build -- Passed. All files up to date [2025-01-14T09:19:48.519Z] REASON: User specified action: run build jdk.test.whitebox.WhiteBox [2025-01-14T09:19:48.519Z] TIME: 0.0 seconds [2025-01-14T09:19:48.519Z] messages: [2025-01-14T09:19:48.519Z] command: build jdk.test.whitebox.WhiteBox [2025-01-14T09:19:48.519Z] reason: User specified action: run build jdk.test.whitebox.WhiteBox [2025-01-14T09:19:48.519Z] started: Tue Jan 14 09:19:38 UTC 2025 [2025-01-14T09:19:48.519Z] finished: Tue Jan 14 09:19:38 UTC 2025 [2025-01-14T09:19:48.519Z] elapsed time (seconds): 0.0 [2025-01-14T09:19:48.519Z] [2025-01-14T09:19:48.519Z] ACTION: build -- Passed. All files up to date [2025-01-14T09:19:48.519Z] REASON: Named class compiled on demand [2025-01-14T09:19:48.519Z] TIME: 0.0 seconds [2025-01-14T09:19:48.519Z] messages: [2025-01-14T09:19:48.519Z] command: build jdk.test.lib.helpers.ClassFileInstaller [2025-01-14T09:19:48.519Z] reason: Named class compiled on demand [2025-01-14T09:19:48.519Z] started: Tue Jan 14 09:19:38 UTC 2025 [2025-01-14T09:19:48.519Z] finished: Tue Jan 14 09:19:38 UTC 2025 [2025-01-14T09:19:48.519Z] elapsed time (seconds): 0.0 [2025-01-14T09:19:48.519Z] [2025-01-14T09:19:48.519Z] ACTION: driver -- Passed. Execution successful [2025-01-14T09:19:48.519Z] REASON: User specified action: run driver jdk.test.lib.helpers.ClassFileInstaller jdk.test.whitebox.WhiteBox [2025-01-14T09:19:48.519Z] TIME: 0.405 seconds [2025-01-14T09:19:48.519Z] messages: [2025-01-14T09:19:48.519Z] command: driver jdk.test.lib.helpers.ClassFileInstaller jdk.test.whitebox.WhiteBox [2025-01-14T09:19:48.519Z] reason: User specified action: run driver jdk.test.lib.helpers.ClassFileInstaller jdk.test.whitebox.WhiteBox [2025-01-14T09:19:48.519Z] started: Tue Jan 14 09:19:38 UTC 2025 [2025-01-14T09:19:48.519Z] Mode: othervm [test requires --enable-preview] [2025-01-14T09:19:48.519Z] finished: Tue Jan 14 09:19:39 UTC 2025 [2025-01-14T09:19:48.519Z] elapsed time (seconds): 0.405 [2025-01-14T09:19:48.519Z] configuration: [2025-01-14T09:19:48.519Z] STDOUT: [2025-01-14T09:19:48.519Z] STDERR: [2025-01-14T09:19:48.519Z] STATUS:Passed. [2025-01-14T09:19:48.519Z] rerun: [2025-01-14T09:19:48.519Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\1' && \ [2025-01-14T09:19:48.519Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps' \ [2025-01-14T09:19:48.519Z] SystemDrive=C: \ [2025-01-14T09:19:48.519Z] SystemRoot='C:\Windows' \ [2025-01-14T09:19:48.519Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.519Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.519Z] windir='C:\Windows' \ [2025-01-14T09:19:48.519Z] CLASSPATH='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar' \ [2025-01-14T09:19:48.519Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\java' \ [2025-01-14T09:19:48.519Z] -Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:19:48.519Z] -Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:19:48.519Z] -Dtest.compiler.opts= \ [2025-01-14T09:19:48.519Z] -Dtest.java.opts= \ [2025-01-14T09:19:48.519Z] -Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.519Z] -Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.519Z] -Dtest.timeout.factor=8.0 \ [2025-01-14T09:19:48.519Z] -Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.519Z] -Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.519Z] -Dtest.name=serviceability/jvmti/vthread/ToggleNotifyJvmtiTest/ToggleNotifyJvmtiTest.java \ [2025-01-14T09:19:48.519Z] -Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.java' \ [2025-01-14T09:19:48.519Z] -Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest' \ [2025-01-14T09:19:48.519Z] -Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.519Z] -Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d' \ [2025-01-14T09:19:48.519Z] -Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.519Z] -Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.519Z] -Dtest.enable.preview=true \ [2025-01-14T09:19:48.519Z] -ea \ [2025-01-14T09:19:48.519Z] -esa \ [2025-01-14T09:19:48.519Z] -Xmx512m \ [2025-01-14T09:19:48.519Z] '-Djava.library.path=C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.519Z] --enable-preview \ [2025-01-14T09:19:48.519Z] com.sun.javatest.regtest.agent.MainWrapper 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d\driver.0.jta' jdk.test.whitebox.WhiteBox [2025-01-14T09:19:48.519Z] [2025-01-14T09:19:48.519Z] ACTION: build -- Passed. Build successful [2025-01-14T09:19:48.519Z] REASON: Named class compiled on demand [2025-01-14T09:19:48.519Z] TIME: 0.106 seconds [2025-01-14T09:19:48.519Z] messages: [2025-01-14T09:19:48.519Z] command: build ToggleNotifyJvmtiTest [2025-01-14T09:19:48.519Z] reason: Named class compiled on demand [2025-01-14T09:19:48.519Z] started: Tue Jan 14 09:19:39 UTC 2025 [2025-01-14T09:19:48.519Z] Test directory: [2025-01-14T09:19:48.519Z] compile: ToggleNotifyJvmtiTest [2025-01-14T09:19:48.519Z] finished: Tue Jan 14 09:19:39 UTC 2025 [2025-01-14T09:19:48.519Z] elapsed time (seconds): 0.106 [2025-01-14T09:19:48.519Z] [2025-01-14T09:19:48.519Z] ACTION: compile -- Passed. Compilation successful [2025-01-14T09:19:48.519Z] REASON: .class file out of date or does not exist [2025-01-14T09:19:48.519Z] TIME: 0.104 seconds [2025-01-14T09:19:48.519Z] messages: [2025-01-14T09:19:48.519Z] command: compile C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.java [2025-01-14T09:19:48.519Z] reason: .class file out of date or does not exist [2025-01-14T09:19:48.519Z] started: Tue Jan 14 09:19:39 UTC 2025 [2025-01-14T09:19:48.519Z] Mode: agentvm [2025-01-14T09:19:48.519Z] Agent id: 2 [2025-01-14T09:19:48.519Z] finished: Tue Jan 14 09:19:39 UTC 2025 [2025-01-14T09:19:48.519Z] elapsed time (seconds): 0.104 [2025-01-14T09:19:48.519Z] configuration: [2025-01-14T09:19:48.519Z] Boot Layer (javac runtime environment) [2025-01-14T09:19:48.519Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar [2025-01-14T09:19:48.519Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar [2025-01-14T09:19:48.519Z] patch: java.base C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\patches\java.base [2025-01-14T09:19:48.520Z] [2025-01-14T09:19:48.520Z] javac compilation environment [2025-01-14T09:19:48.520Z] source path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest [2025-01-14T09:19:48.520Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib [2025-01-14T09:19:48.520Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg [2025-01-14T09:19:48.520Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest [2025-01-14T09:19:48.520Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d [2025-01-14T09:19:48.520Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib [2025-01-14T09:19:48.520Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg [2025-01-14T09:19:48.520Z] [2025-01-14T09:19:48.520Z] rerun: [2025-01-14T09:19:48.520Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\1' && \ [2025-01-14T09:19:48.520Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps' \ [2025-01-14T09:19:48.520Z] SystemDrive=C: \ [2025-01-14T09:19:48.520Z] SystemRoot='C:\Windows' \ [2025-01-14T09:19:48.520Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.520Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.520Z] windir='C:\Windows' \ [2025-01-14T09:19:48.520Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\javac' \ [2025-01-14T09:19:48.520Z] -J-ea \ [2025-01-14T09:19:48.520Z] -J-esa \ [2025-01-14T09:19:48.520Z] -J-Xmx512m \ [2025-01-14T09:19:48.520Z] -J-Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:19:48.520Z] -J-Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:19:48.520Z] -J-Dtest.compiler.opts= \ [2025-01-14T09:19:48.520Z] -J-Dtest.java.opts= \ [2025-01-14T09:19:48.520Z] -J-Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.520Z] -J-Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.520Z] -J-Dtest.timeout.factor=8.0 \ [2025-01-14T09:19:48.520Z] -J-Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.520Z] -J-Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.520Z] -J-Dtest.name=serviceability/jvmti/vthread/ToggleNotifyJvmtiTest/ToggleNotifyJvmtiTest.java \ [2025-01-14T09:19:48.520Z] -J-Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.java' \ [2025-01-14T09:19:48.520Z] -J-Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest' \ [2025-01-14T09:19:48.520Z] -J-Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.520Z] -J-Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d' \ [2025-01-14T09:19:48.520Z] -J-Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.520Z] -J-Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.520Z] -J-Dtest.enable.preview=true \ [2025-01-14T09:19:48.520Z] -d 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d' \ [2025-01-14T09:19:48.520Z] -sourcepath 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.520Z] -classpath 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.520Z] --enable-preview \ [2025-01-14T09:19:48.520Z] --source=25 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.java' [2025-01-14T09:19:48.520Z] [2025-01-14T09:19:48.520Z] ACTION: main -- Passed. Execution successful [2025-01-14T09:19:48.520Z] REASON: User specified action: run main/othervm/native -XX:+UnlockDiagnosticVMOptions -XX:+WhiteBoxAPI -Xbootclasspath/a:. -agentlib:ToggleNotifyJvmtiTest ToggleNotifyJvmtiTest [2025-01-14T09:19:48.520Z] TIME: 0.997 seconds [2025-01-14T09:19:48.520Z] messages: [2025-01-14T09:19:48.520Z] command: main -XX:+UnlockDiagnosticVMOptions -XX:+WhiteBoxAPI -Xbootclasspath/a:. -agentlib:ToggleNotifyJvmtiTest ToggleNotifyJvmtiTest [2025-01-14T09:19:48.520Z] reason: User specified action: run main/othervm/native -XX:+UnlockDiagnosticVMOptions -XX:+WhiteBoxAPI -Xbootclasspath/a:. -agentlib:ToggleNotifyJvmtiTest ToggleNotifyJvmtiTest [2025-01-14T09:19:48.520Z] started: Tue Jan 14 09:19:39 UTC 2025 [2025-01-14T09:19:48.520Z] Mode: othervm [/othervm specified] [2025-01-14T09:19:48.520Z] finished: Tue Jan 14 09:19:40 UTC 2025 [2025-01-14T09:19:48.520Z] elapsed time (seconds): 0.997 [2025-01-14T09:19:48.520Z] configuration: [2025-01-14T09:19:48.520Z] STDOUT: [2025-01-14T09:19:48.520Z] Agent_OnLoad started [2025-01-14T09:19:48.520Z] Agent init: can_support_virtual_threads capability: 1 [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: main vt: (null) [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: Notification Thread vt: (null) [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: Common-Cleaner vt: (null) [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: MainThread vt: (null) [2025-01-14T09:19:48.520Z] # main: loading ToggleNotifyJvmtiTest lib [2025-01-14T09:19:48.520Z] [2025-01-14T09:19:48.520Z] # Java: Started test cycle #0 [2025-01-14T09:19:48.520Z] [2025-01-14T09:19:48.520Z] # main: SetNotifyJvmtiEvents: #0 enable: false [2025-01-14T09:19:48.520Z] [2025-01-14T09:19:48.520Z] # Java: Starting vthreads [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: VirtualThread-unblocker vt: (null) [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-1 vt: (null) [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-2 vt: (null) [2025-01-14T09:19:48.520Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-3 vt: (null) [2025-01-14T09:19:48.520Z] [2025-01-14T09:19:48.521Z] # main: SetNotifyJvmtiEvents: #0 enable: true [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask0 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.521Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-4 vt: (null) [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.521Z] # Started: TestTask2 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.521Z] # Started: TestTask5 [2025-01-14T09:19:48.521Z] # Started: TestTask0 [2025-01-14T09:19:48.521Z] # Started: TestTask3 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask0 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.521Z] # Started: TestTask6 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.521Z] # Started: TestTask7 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.521Z] # Started: TestTask9 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.521Z] # Started: TestTask10 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.521Z] # Started: TestTask11 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.521Z] # Started: TestTask12 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.521Z] # Started: TestTask15 [2025-01-14T09:19:48.521Z] # Started: TestTask13 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.521Z] # Started: TestTask16 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.521Z] # Started: TestTask17 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.521Z] # Started: TestTask18 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.521Z] # Started: TestTask4 [2025-01-14T09:19:48.521Z] # Started: TestTask1 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.521Z] # Started: TestTask19 [2025-01-14T09:19:48.521Z] # Started: TestTask14 [2025-01-14T09:19:48.521Z] # Started: TestTask8 [2025-01-14T09:19:48.521Z] Event: ThreadStart virtual: 0 ct: VirtualThread-unparker vt: (null) [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.521Z] [2025-01-14T09:19:48.521Z] # Java: Finished test cycle #0 [2025-01-14T09:19:48.521Z] VirtualThreadStart events: 20 [2025-01-14T09:19:48.521Z] VirtualThreadEnd events: 20 [2025-01-14T09:19:48.521Z] ThreadStart events: 10 [2025-01-14T09:19:48.521Z] ThreadEnd events: 0 [2025-01-14T09:19:48.521Z] [2025-01-14T09:19:48.521Z] # Java: Started test cycle #1 [2025-01-14T09:19:48.521Z] [2025-01-14T09:19:48.521Z] # main: SetNotifyJvmtiEvents: #1 enable: false [2025-01-14T09:19:48.521Z] [2025-01-14T09:19:48.521Z] # Java: Starting vthreads [2025-01-14T09:19:48.521Z] # Started: TestTask0 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask3 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask6 [2025-01-14T09:19:48.521Z] # Started: TestTask2 [2025-01-14T09:19:48.521Z] [2025-01-14T09:19:48.521Z] # main: SetNotifyJvmtiEvents: #1 enable: true [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.521Z] # Started: TestTask7 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask8 [2025-01-14T09:19:48.521Z] # Started: TestTask8 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.521Z] # Started: TestTask9 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask10 [2025-01-14T09:19:48.521Z] # Started: TestTask10 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.521Z] # Started: TestTask11 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.521Z] # Started: TestTask12 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask13 [2025-01-14T09:19:48.521Z] # Started: TestTask13 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.521Z] # Started: TestTask14 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.521Z] # Started: TestTask15 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.521Z] # Started: TestTask16 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask17 [2025-01-14T09:19:48.521Z] # Started: TestTask17 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.521Z] # Started: TestTask18 [2025-01-14T09:19:48.521Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.521Z] # Started: TestTask19 [2025-01-14T09:19:48.521Z] # Started: TestTask1 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask1 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.521Z] # Started: TestTask6 [2025-01-14T09:19:48.521Z] # Started: TestTask5 [2025-01-14T09:19:48.521Z] # Started: TestTask3 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.521Z] # Started: TestTask4 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask4 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask10 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.521Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.521Z] [2025-01-14T09:19:48.521Z] # Java: Finished test cycle #1 [2025-01-14T09:19:48.521Z] VirtualThreadStart events: 37 [2025-01-14T09:19:48.521Z] VirtualThreadEnd events: 40 [2025-01-14T09:19:48.521Z] ThreadStart events: 10 [2025-01-14T09:19:48.521Z] ThreadEnd events: 0 [2025-01-14T09:19:48.521Z] [2025-01-14T09:19:48.522Z] # Java: Started test cycle #2 [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # main: SetNotifyJvmtiEvents: #2 enable: false [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # Java: Starting vthreads [2025-01-14T09:19:48.522Z] # Started: TestTask0 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.522Z] # Started: TestTask1 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.522Z] # Started: TestTask2 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.522Z] # Started: TestTask3 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.522Z] # Started: TestTask4 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.522Z] # Started: TestTask5 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask7 [2025-01-14T09:19:48.522Z] # Started: TestTask6 [2025-01-14T09:19:48.522Z] # Started: TestTask7 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.522Z] # Started: TestTask8 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.522Z] # Started: TestTask9 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask10 [2025-01-14T09:19:48.522Z] # Started: TestTask10 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.522Z] # Started: TestTask11 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.522Z] # Started: TestTask12 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.522Z] # Started: TestTask13 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask15 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.522Z] # Started: TestTask14 [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # main: SetNotifyJvmtiEvents: #2 enable: true [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.522Z] # Started: TestTask19 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.522Z] # Started: TestTask18 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.522Z] # Started: TestTask17 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.522Z] # Started: TestTask16 [2025-01-14T09:19:48.522Z] # Started: TestTask15 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # Java: Finished test cycle #2 [2025-01-14T09:19:48.522Z] VirtualThreadStart events: 56 [2025-01-14T09:19:48.522Z] VirtualThreadEnd events: 60 [2025-01-14T09:19:48.522Z] ThreadStart events: 10 [2025-01-14T09:19:48.522Z] ThreadEnd events: 0 [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # Java: Started test cycle #3 [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # main: SetNotifyJvmtiEvents: #3 enable: false [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # Java: Starting vthreads [2025-01-14T09:19:48.522Z] # Started: TestTask0 [2025-01-14T09:19:48.522Z] # Started: TestTask3 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.522Z] # Started: TestTask4 [2025-01-14T09:19:48.522Z] # Started: TestTask5 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.522Z] # Started: TestTask6 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask7 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask8 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.522Z] # Started: TestTask7 [2025-01-14T09:19:48.522Z] # Started: TestTask11 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.522Z] # Started: TestTask13 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.522Z] # Started: TestTask14 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.522Z] # Started: TestTask15 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask16 [2025-01-14T09:19:48.522Z] # Started: TestTask16 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.522Z] # Started: TestTask17 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.522Z] # Started: TestTask18 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.522Z] # Started: TestTask19 [2025-01-14T09:19:48.522Z] # Started: TestTask2 [2025-01-14T09:19:48.522Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.522Z] # Started: TestTask12 [2025-01-14T09:19:48.522Z] # Started: TestTask1 [2025-01-14T09:19:48.522Z] [2025-01-14T09:19:48.522Z] # main: SetNotifyJvmtiEvents: #3 enable: true [2025-01-14T09:19:48.522Z] # Started: TestTask10 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.522Z] # Started: TestTask9 [2025-01-14T09:19:48.522Z] # Started: TestTask8 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask3 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.522Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask10 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask17 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # Java: Finished test cycle #3 [2025-01-14T09:19:48.523Z] VirtualThreadStart events: 72 [2025-01-14T09:19:48.523Z] VirtualThreadEnd events: 80 [2025-01-14T09:19:48.523Z] ThreadStart events: 10 [2025-01-14T09:19:48.523Z] ThreadEnd events: 0 [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # Java: Started test cycle #4 [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # main: SetNotifyJvmtiEvents: #4 enable: false [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # Java: Starting vthreads [2025-01-14T09:19:48.523Z] # Started: TestTask0 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.523Z] # Started: TestTask2 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.523Z] # Started: TestTask3 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask4 [2025-01-14T09:19:48.523Z] # Started: TestTask4 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.523Z] # Started: TestTask5 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask6 [2025-01-14T09:19:48.523Z] # Started: TestTask6 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.523Z] # Started: TestTask7 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask8 [2025-01-14T09:19:48.523Z] # Started: TestTask8 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask9 [2025-01-14T09:19:48.523Z] # Started: TestTask9 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.523Z] # Started: TestTask10 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.523Z] # Started: TestTask11 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.523Z] # Started: TestTask12 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.523Z] # Started: TestTask13 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.523Z] # Started: TestTask14 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask16 [2025-01-14T09:19:48.523Z] # Started: TestTask15 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.523Z] # Started: TestTask17 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.523Z] # Started: TestTask18 [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # main: SetNotifyJvmtiEvents: #4 enable: true [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.523Z] # Started: TestTask19 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.523Z] # Started: TestTask1 [2025-01-14T09:19:48.523Z] # Started: TestTask16 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask0 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask1 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask2 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.523Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # Java: Finished test cycle #4 [2025-01-14T09:19:48.523Z] VirtualThreadStart events: 91 [2025-01-14T09:19:48.523Z] VirtualThreadEnd events: 100 [2025-01-14T09:19:48.523Z] ThreadStart events: 10 [2025-01-14T09:19:48.523Z] ThreadEnd events: 0 [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # Java: Started test cycle #5 [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # main: SetNotifyJvmtiEvents: #5 enable: false [2025-01-14T09:19:48.523Z] [2025-01-14T09:19:48.523Z] # Java: Starting vthreads [2025-01-14T09:19:48.523Z] # Started: TestTask0 [2025-01-14T09:19:48.523Z] # Started: TestTask4 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.523Z] # Started: TestTask5 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.523Z] # Started: TestTask3 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.523Z] # Started: TestTask7 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.523Z] # Started: TestTask8 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.523Z] # Started: TestTask9 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask10 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask16 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask17 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.523Z] # Started: TestTask10 [2025-01-14T09:19:48.523Z] # Started: TestTask2 [2025-01-14T09:19:48.523Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask13 [2025-01-14T09:19:48.523Z] # Started: TestTask13 [2025-01-14T09:19:48.523Z] # Started: TestTask1 [2025-01-14T09:19:48.523Z] # Started: TestTask19 [2025-01-14T09:19:48.523Z] # Started: TestTask18 [2025-01-14T09:19:48.523Z] # Started: TestTask17 [2025-01-14T09:19:48.523Z] # Started: TestTask16 [2025-01-14T09:19:48.523Z] # Started: TestTask15 [2025-01-14T09:19:48.523Z] # Started: TestTask14 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # main: SetNotifyJvmtiEvents: #5 enable: true [2025-01-14T09:19:48.524Z] # Started: TestTask12 [2025-01-14T09:19:48.524Z] # Started: TestTask11 [2025-01-14T09:19:48.524Z] # Started: TestTask6 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask5 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask6 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask15 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # Java: Finished test cycle #5 [2025-01-14T09:19:48.524Z] VirtualThreadStart events: 106 [2025-01-14T09:19:48.524Z] VirtualThreadEnd events: 120 [2025-01-14T09:19:48.524Z] ThreadStart events: 10 [2025-01-14T09:19:48.524Z] ThreadEnd events: 0 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # Java: Started test cycle #6 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # main: SetNotifyJvmtiEvents: #6 enable: false [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # Java: Starting vthreads [2025-01-14T09:19:48.524Z] # Started: TestTask0 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.524Z] # Started: TestTask1 [2025-01-14T09:19:48.524Z] # Started: TestTask3 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask4 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # main: SetNotifyJvmtiEvents: #6 enable: true [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask0 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask2 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.524Z] # Started: TestTask4 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.524Z] # Started: TestTask5 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask7 [2025-01-14T09:19:48.524Z] # Started: TestTask7 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.524Z] # Started: TestTask10 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.524Z] # Started: TestTask8 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask12 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask15 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.524Z] # Started: TestTask16 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.524Z] # Started: TestTask17 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.524Z] # Started: TestTask18 [2025-01-14T09:19:48.524Z] # Started: TestTask6 [2025-01-14T09:19:48.524Z] # Started: TestTask2 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.524Z] # Started: TestTask9 [2025-01-14T09:19:48.524Z] # Started: TestTask19 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.524Z] # Started: TestTask15 [2025-01-14T09:19:48.524Z] # Started: TestTask14 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.524Z] # Started: TestTask13 [2025-01-14T09:19:48.524Z] # Started: TestTask12 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.524Z] # Started: TestTask11 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask9 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # Java: Finished test cycle #6 [2025-01-14T09:19:48.524Z] VirtualThreadStart events: 125 [2025-01-14T09:19:48.524Z] VirtualThreadEnd events: 140 [2025-01-14T09:19:48.524Z] ThreadStart events: 10 [2025-01-14T09:19:48.524Z] ThreadEnd events: 0 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # Java: Started test cycle #7 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # main: SetNotifyJvmtiEvents: #7 enable: false [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # Java: Starting vthreads [2025-01-14T09:19:48.524Z] # Started: TestTask0 [2025-01-14T09:19:48.524Z] # Started: TestTask4 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask10 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.524Z] # Started: TestTask10 [2025-01-14T09:19:48.524Z] # Started: TestTask11 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.524Z] # Started: TestTask12 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.524Z] # Started: TestTask15 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.524Z] # Started: TestTask17 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.524Z] # Started: TestTask18 [2025-01-14T09:19:48.524Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.524Z] # Started: TestTask19 [2025-01-14T09:19:48.524Z] # Started: TestTask3 [2025-01-14T09:19:48.524Z] # Started: TestTask1 [2025-01-14T09:19:48.524Z] # Started: TestTask16 [2025-01-14T09:19:48.524Z] # Started: TestTask13 [2025-01-14T09:19:48.524Z] # Started: TestTask14 [2025-01-14T09:19:48.524Z] [2025-01-14T09:19:48.524Z] # main: SetNotifyJvmtiEvents: #7 enable: true [2025-01-14T09:19:48.524Z] # Started: TestTask9 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask0 [2025-01-14T09:19:48.524Z] # Started: TestTask8 [2025-01-14T09:19:48.524Z] # Started: TestTask7 [2025-01-14T09:19:48.524Z] # Started: TestTask6 [2025-01-14T09:19:48.524Z] # Started: TestTask5 [2025-01-14T09:19:48.524Z] # Started: TestTask2 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask4 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.524Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask9 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask16 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # Java: Finished test cycle #7 [2025-01-14T09:19:48.525Z] VirtualThreadStart events: 135 [2025-01-14T09:19:48.525Z] VirtualThreadEnd events: 160 [2025-01-14T09:19:48.525Z] ThreadStart events: 10 [2025-01-14T09:19:48.525Z] ThreadEnd events: 0 [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # Java: Started test cycle #8 [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # main: SetNotifyJvmtiEvents: #8 enable: false [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # Java: Starting vthreads [2025-01-14T09:19:48.525Z] # Started: TestTask0 [2025-01-14T09:19:48.525Z] # Started: TestTask3 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.525Z] # Started: TestTask4 [2025-01-14T09:19:48.525Z] # Started: TestTask2 [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # main: SetNotifyJvmtiEvents: #8 enable: true [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.525Z] # Started: TestTask6 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.525Z] # Started: TestTask5 [2025-01-14T09:19:48.525Z] # Started: TestTask1 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.525Z] # Started: TestTask8 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.525Z] # Started: TestTask9 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask10 [2025-01-14T09:19:48.525Z] # Started: TestTask10 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.525Z] # Started: TestTask11 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.525Z] # Started: TestTask7 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.525Z] # Started: TestTask12 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.525Z] # Started: TestTask13 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.525Z] # Started: TestTask15 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask16 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.525Z] # Started: TestTask16 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.525Z] # Started: TestTask14 [2025-01-14T09:19:48.525Z] # Started: TestTask19 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask2 [2025-01-14T09:19:48.525Z] # Started: TestTask18 [2025-01-14T09:19:48.525Z] # Started: TestTask17 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask3 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask4 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.525Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # Java: Finished test cycle #8 [2025-01-14T09:19:48.525Z] VirtualThreadStart events: 151 [2025-01-14T09:19:48.525Z] VirtualThreadEnd events: 180 [2025-01-14T09:19:48.525Z] ThreadStart events: 10 [2025-01-14T09:19:48.525Z] ThreadEnd events: 0 [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # Java: Started test cycle #9 [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # main: SetNotifyJvmtiEvents: #9 enable: false [2025-01-14T09:19:48.525Z] [2025-01-14T09:19:48.525Z] # Java: Starting vthreads [2025-01-14T09:19:48.525Z] # Started: TestTask0 [2025-01-14T09:19:48.525Z] # Started: TestTask1 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.525Z] # Started: TestTask2 [2025-01-14T09:19:48.525Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.525Z] # Started: TestTask4 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.526Z] # Started: TestTask5 [2025-01-14T09:19:48.526Z] # Started: TestTask6 [2025-01-14T09:19:48.526Z] [2025-01-14T09:19:48.526Z] # main: SetNotifyJvmtiEvents: #9 enable: true [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask3 [2025-01-14T09:19:48.526Z] # Started: TestTask3 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask7 [2025-01-14T09:19:48.526Z] # Started: TestTask7 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.526Z] # Started: TestTask8 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.526Z] # Started: TestTask9 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.526Z] # Started: TestTask10 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.526Z] # Started: TestTask11 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.526Z] # Started: TestTask12 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.526Z] # Started: TestTask13 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.526Z] # Started: TestTask14 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask15 [2025-01-14T09:19:48.526Z] # Started: TestTask15 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.526Z] # Started: TestTask16 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask17 [2025-01-14T09:19:48.526Z] # Started: TestTask17 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask18 [2025-01-14T09:19:48.526Z] # Started: TestTask18 [2025-01-14T09:19:48.526Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.526Z] # Started: TestTask19 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask0 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask4 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask16 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.526Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.526Z] [2025-01-14T09:19:48.526Z] # Java: Finished test cycle #9 [2025-01-14T09:19:48.526Z] VirtualThreadStart events: 169 [2025-01-14T09:19:48.526Z] VirtualThreadEnd events: 200 [2025-01-14T09:19:48.526Z] ThreadStart events: 10 [2025-01-14T09:19:48.526Z] ThreadEnd events: 0 [2025-01-14T09:19:48.526Z] Event: ThreadEnd virtual: 0 ct: MainThread vt: (null) [2025-01-14T09:19:48.526Z] Event: ThreadEnd virtual: 0 ct: main vt: (null) [2025-01-14T09:19:48.526Z] STDERR: [2025-01-14T09:19:48.526Z] STATUS:Passed. [2025-01-14T09:19:48.526Z] rerun: [2025-01-14T09:19:48.526Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\1' && \ [2025-01-14T09:19:48.526Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.526Z] SystemDrive=C: \ [2025-01-14T09:19:48.526Z] SystemRoot='C:\Windows' \ [2025-01-14T09:19:48.526Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.526Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.526Z] windir='C:\Windows' \ [2025-01-14T09:19:48.526Z] CLASSPATH='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar' \ [2025-01-14T09:19:48.526Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\java' \ [2025-01-14T09:19:48.526Z] -Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:19:48.526Z] -Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:19:48.526Z] -Dtest.compiler.opts= \ [2025-01-14T09:19:48.526Z] -Dtest.java.opts= \ [2025-01-14T09:19:48.526Z] -Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.526Z] -Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.526Z] -Dtest.timeout.factor=8.0 \ [2025-01-14T09:19:48.526Z] -Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.526Z] -Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.526Z] -Dtest.name=serviceability/jvmti/vthread/ToggleNotifyJvmtiTest/ToggleNotifyJvmtiTest.java \ [2025-01-14T09:19:48.526Z] -Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.java' \ [2025-01-14T09:19:48.526Z] -Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest' \ [2025-01-14T09:19:48.526Z] -Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.526Z] -Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d' \ [2025-01-14T09:19:48.526Z] -Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.526Z] -Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.526Z] -Dtest.enable.preview=true \ [2025-01-14T09:19:48.526Z] -ea \ [2025-01-14T09:19:48.526Z] -esa \ [2025-01-14T09:19:48.526Z] -Xmx512m \ [2025-01-14T09:19:48.526Z] '-Djava.library.path=C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.527Z] -XX:+UnlockDiagnosticVMOptions \ [2025-01-14T09:19:48.527Z] -XX:+WhiteBoxAPI \ [2025-01-14T09:19:48.527Z] -Xbootclasspath/a:. \ [2025-01-14T09:19:48.527Z] -agentlib:ToggleNotifyJvmtiTest \ [2025-01-14T09:19:48.527Z] --enable-preview \ [2025-01-14T09:19:48.527Z] com.sun.javatest.regtest.agent.MainWrapper 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d\main.1.jta' [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] ACTION: build -- Passed. All files up to date [2025-01-14T09:19:48.527Z] REASON: Named class compiled on demand [2025-01-14T09:19:48.527Z] TIME: 0.0 seconds [2025-01-14T09:19:48.527Z] messages: [2025-01-14T09:19:48.527Z] command: build ToggleNotifyJvmtiTest [2025-01-14T09:19:48.527Z] reason: Named class compiled on demand [2025-01-14T09:19:48.527Z] started: Tue Jan 14 09:19:40 UTC 2025 [2025-01-14T09:19:48.527Z] finished: Tue Jan 14 09:19:40 UTC 2025 [2025-01-14T09:19:48.527Z] elapsed time (seconds): 0.0 [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] ACTION: main -- Failed. Unexpected exit from test [exit code: -2147483647] [2025-01-14T09:19:48.527Z] REASON: User specified action: run main/othervm/native -XX:+UnlockDiagnosticVMOptions -XX:+WhiteBoxAPI -Xbootclasspath/a:. -Djdk.attach.allowAttachSelf=true ToggleNotifyJvmtiTest attach [2025-01-14T09:19:48.527Z] TIME: 3.903 seconds [2025-01-14T09:19:48.527Z] messages: [2025-01-14T09:19:48.527Z] command: main -XX:+UnlockDiagnosticVMOptions -XX:+WhiteBoxAPI -Xbootclasspath/a:. -Djdk.attach.allowAttachSelf=true ToggleNotifyJvmtiTest attach [2025-01-14T09:19:48.527Z] reason: User specified action: run main/othervm/native -XX:+UnlockDiagnosticVMOptions -XX:+WhiteBoxAPI -Xbootclasspath/a:. -Djdk.attach.allowAttachSelf=true ToggleNotifyJvmtiTest attach [2025-01-14T09:19:48.527Z] started: Tue Jan 14 09:19:40 UTC 2025 [2025-01-14T09:19:48.527Z] Mode: othervm [/othervm specified] [2025-01-14T09:19:48.527Z] finished: Tue Jan 14 09:19:44 UTC 2025 [2025-01-14T09:19:48.527Z] elapsed time (seconds): 3.903 [2025-01-14T09:19:48.527Z] configuration: [2025-01-14T09:19:48.527Z] STDOUT: [2025-01-14T09:19:48.527Z] # main: loading ToggleNotifyJvmtiTest lib [2025-01-14T09:19:48.527Z] Agent_OnAttach started [2025-01-14T09:19:48.527Z] Agent init: can_support_virtual_threads capability: 1 [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # Java: Started test cycle #0 [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # main: SetNotifyJvmtiEvents: #0 enable: false [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # Java: Starting vthreads [2025-01-14T09:19:48.527Z] Event: ThreadStart virtual: 0 ct: VirtualThread-unblocker vt: (null) [2025-01-14T09:19:48.527Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-2 vt: (null) [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # main: SetNotifyJvmtiEvents: #0 enable: true [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.527Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-1 vt: (null) [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask1 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask9 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.527Z] # Started: TestTask0 [2025-01-14T09:19:48.527Z] # Started: TestTask10 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.527Z] # Started: TestTask11 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask12 [2025-01-14T09:19:48.527Z] # Started: TestTask12 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask13 [2025-01-14T09:19:48.527Z] # Started: TestTask13 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.527Z] # Started: TestTask15 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.527Z] # Started: TestTask17 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.527Z] # Started: TestTask18 [2025-01-14T09:19:48.527Z] # Started: TestTask19 [2025-01-14T09:19:48.527Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-3 vt: (null) [2025-01-14T09:19:48.527Z] # Started: TestTask9 [2025-01-14T09:19:48.527Z] # Started: TestTask8 [2025-01-14T09:19:48.527Z] # Started: TestTask7 [2025-01-14T09:19:48.527Z] # Started: TestTask6 [2025-01-14T09:19:48.527Z] # Started: TestTask5 [2025-01-14T09:19:48.527Z] # Started: TestTask4 [2025-01-14T09:19:48.527Z] # Started: TestTask3 [2025-01-14T09:19:48.527Z] # Started: TestTask2 [2025-01-14T09:19:48.527Z] # Started: TestTask1 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.527Z] # Started: TestTask16 [2025-01-14T09:19:48.527Z] # Started: TestTask14 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.527Z] Event: ThreadStart virtual: 0 ct: ForkJoinPool-1-worker-4 vt: (null) [2025-01-14T09:19:48.527Z] Event: ThreadStart virtual: 0 ct: VirtualThread-unparker vt: (null) [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask4 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask9 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask10 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # Java: Finished test cycle #0 [2025-01-14T09:19:48.527Z] VirtualThreadStart events: 20 [2025-01-14T09:19:48.527Z] VirtualThreadEnd events: 20 [2025-01-14T09:19:48.527Z] ThreadStart events: 6 [2025-01-14T09:19:48.527Z] ThreadEnd events: 0 [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # Java: Started test cycle #1 [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # main: SetNotifyJvmtiEvents: #1 enable: false [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # Java: Starting vthreads [2025-01-14T09:19:48.527Z] # Started: TestTask0 [2025-01-14T09:19:48.527Z] [2025-01-14T09:19:48.527Z] # main: SetNotifyJvmtiEvents: #1 enable: true [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.527Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask0 [2025-01-14T09:19:48.527Z] # Started: TestTask2 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask4 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.527Z] # Started: TestTask4 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask3 [2025-01-14T09:19:48.527Z] # Started: TestTask3 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.527Z] # Started: TestTask6 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.527Z] # Started: TestTask7 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.527Z] # Started: TestTask8 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask9 [2025-01-14T09:19:48.527Z] # Started: TestTask9 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.527Z] # Started: TestTask10 [2025-01-14T09:19:48.527Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.527Z] # Started: TestTask11 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.528Z] # Started: TestTask12 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.528Z] # Started: TestTask13 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.528Z] # Started: TestTask14 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.528Z] # Started: TestTask15 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.528Z] # Started: TestTask17 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.528Z] # Started: TestTask18 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.528Z] # Started: TestTask19 [2025-01-14T09:19:48.528Z] # Started: TestTask1 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask16 [2025-01-14T09:19:48.528Z] # Started: TestTask16 [2025-01-14T09:19:48.528Z] # Started: TestTask5 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask3 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask5 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask7 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask8 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask16 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # Java: Finished test cycle #1 [2025-01-14T09:19:48.528Z] VirtualThreadStart events: 38 [2025-01-14T09:19:48.528Z] VirtualThreadEnd events: 40 [2025-01-14T09:19:48.528Z] ThreadStart events: 6 [2025-01-14T09:19:48.528Z] ThreadEnd events: 0 [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # Java: Started test cycle #2 [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # main: SetNotifyJvmtiEvents: #2 enable: false [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # Java: Starting vthreads [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.528Z] # Started: TestTask0 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.528Z] # Started: TestTask3 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.528Z] # Started: TestTask4 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.528Z] # Started: TestTask5 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.528Z] # Started: TestTask7 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.528Z] # Started: TestTask8 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.528Z] # Started: TestTask9 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.528Z] # Started: TestTask14 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.528Z] # Started: TestTask15 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask16 [2025-01-14T09:19:48.528Z] # Started: TestTask16 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask18 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.528Z] # Started: TestTask12 [2025-01-14T09:19:48.528Z] # Started: TestTask2 [2025-01-14T09:19:48.528Z] # Started: TestTask1 [2025-01-14T09:19:48.528Z] # Started: TestTask19 [2025-01-14T09:19:48.528Z] # Started: TestTask18 [2025-01-14T09:19:48.528Z] # Started: TestTask17 [2025-01-14T09:19:48.528Z] # Started: TestTask13 [2025-01-14T09:19:48.528Z] # Started: TestTask11 [2025-01-14T09:19:48.528Z] # Started: TestTask10 [2025-01-14T09:19:48.528Z] # Started: TestTask6 [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # main: SetNotifyJvmtiEvents: #2 enable: true [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask0 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask4 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask5 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask12 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask15 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask18 [2025-01-14T09:19:48.528Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # Java: Finished test cycle #2 [2025-01-14T09:19:48.528Z] VirtualThreadStart events: 56 [2025-01-14T09:19:48.528Z] VirtualThreadEnd events: 60 [2025-01-14T09:19:48.528Z] ThreadStart events: 6 [2025-01-14T09:19:48.528Z] ThreadEnd events: 0 [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # Java: Started test cycle #3 [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # main: SetNotifyJvmtiEvents: #3 enable: false [2025-01-14T09:19:48.528Z] [2025-01-14T09:19:48.528Z] # Java: Starting vthreads [2025-01-14T09:19:48.528Z] # Started: TestTask0 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.528Z] # Started: TestTask1 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.528Z] # Started: TestTask4 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.528Z] # Started: TestTask3 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.528Z] # Started: TestTask5 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.528Z] # Started: TestTask6 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.528Z] # Started: TestTask7 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask8 [2025-01-14T09:19:48.528Z] # Started: TestTask8 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.528Z] # Started: TestTask9 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.528Z] # Started: TestTask10 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask11 [2025-01-14T09:19:48.528Z] # Started: TestTask11 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask12 [2025-01-14T09:19:48.528Z] # Started: TestTask12 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask13 [2025-01-14T09:19:48.528Z] # Started: TestTask13 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.528Z] # Started: TestTask14 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask15 [2025-01-14T09:19:48.528Z] # Started: TestTask15 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.528Z] # Started: TestTask16 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.528Z] # Started: TestTask17 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.528Z] # Started: TestTask18 [2025-01-14T09:19:48.528Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.528Z] # Started: TestTask2 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # main: SetNotifyJvmtiEvents: #3 enable: true [2025-01-14T09:19:48.529Z] # Started: TestTask19 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask0 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask2 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask3 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask4 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask7 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask16 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask18 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # Java: Finished test cycle #3 [2025-01-14T09:19:48.529Z] VirtualThreadStart events: 75 [2025-01-14T09:19:48.529Z] VirtualThreadEnd events: 80 [2025-01-14T09:19:48.529Z] ThreadStart events: 6 [2025-01-14T09:19:48.529Z] ThreadEnd events: 0 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # Java: Started test cycle #4 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # main: SetNotifyJvmtiEvents: #4 enable: false [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # Java: Starting vthreads [2025-01-14T09:19:48.529Z] # Started: TestTask0 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask1 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.529Z] # Started: TestTask1 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.529Z] # Started: TestTask7 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.529Z] # Started: TestTask8 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.529Z] # Started: TestTask2 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.529Z] # Started: TestTask9 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.529Z] # Started: TestTask10 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.529Z] # Started: TestTask11 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.529Z] # Started: TestTask12 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask13 [2025-01-14T09:19:48.529Z] # Started: TestTask13 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.529Z] # Started: TestTask14 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.529Z] # Started: TestTask15 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.529Z] # Started: TestTask16 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.529Z] # Started: TestTask17 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.529Z] # Started: TestTask18 [2025-01-14T09:19:48.529Z] # Started: TestTask19 [2025-01-14T09:19:48.529Z] # Started: TestTask6 [2025-01-14T09:19:48.529Z] # Started: TestTask5 [2025-01-14T09:19:48.529Z] # Started: TestTask4 [2025-01-14T09:19:48.529Z] # Started: TestTask3 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # main: SetNotifyJvmtiEvents: #4 enable: true [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask0 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask2 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask3 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask5 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask7 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask9 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask11 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # Java: Finished test cycle #4 [2025-01-14T09:19:48.529Z] VirtualThreadStart events: 94 [2025-01-14T09:19:48.529Z] VirtualThreadEnd events: 100 [2025-01-14T09:19:48.529Z] ThreadStart events: 6 [2025-01-14T09:19:48.529Z] ThreadEnd events: 0 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # Java: Started test cycle #5 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # main: SetNotifyJvmtiEvents: #5 enable: false [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # Java: Starting vthreads [2025-01-14T09:19:48.529Z] # Started: TestTask0 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.529Z] # Started: TestTask3 [2025-01-14T09:19:48.529Z] # Started: TestTask4 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.529Z] # Started: TestTask5 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask6 [2025-01-14T09:19:48.529Z] # Started: TestTask6 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask8 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.529Z] # Started: TestTask8 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask10 [2025-01-14T09:19:48.529Z] # Started: TestTask10 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask11 [2025-01-14T09:19:48.529Z] # Started: TestTask11 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.529Z] # Started: TestTask12 [2025-01-14T09:19:48.529Z] [2025-01-14T09:19:48.529Z] # main: SetNotifyJvmtiEvents: #5 enable: true [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.529Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask0 [2025-01-14T09:19:48.529Z] # Started: TestTask13 [2025-01-14T09:19:48.529Z] # Started: TestTask2 [2025-01-14T09:19:48.529Z] # Started: TestTask1 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.529Z] # Started: TestTask19 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.529Z] # Started: TestTask14 [2025-01-14T09:19:48.529Z] # Started: TestTask18 [2025-01-14T09:19:48.529Z] # Started: TestTask17 [2025-01-14T09:19:48.529Z] # Started: TestTask16 [2025-01-14T09:19:48.529Z] # Started: TestTask15 [2025-01-14T09:19:48.529Z] # Started: TestTask7 [2025-01-14T09:19:48.529Z] # Started: TestTask9 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask3 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask4 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask6 [2025-01-14T09:19:48.529Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask8 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask12 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # Java: Finished test cycle #5 [2025-01-14T09:19:48.530Z] VirtualThreadStart events: 110 [2025-01-14T09:19:48.530Z] VirtualThreadEnd events: 120 [2025-01-14T09:19:48.530Z] ThreadStart events: 6 [2025-01-14T09:19:48.530Z] ThreadEnd events: 0 [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # Java: Started test cycle #6 [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # main: SetNotifyJvmtiEvents: #6 enable: false [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # Java: Starting vthreads [2025-01-14T09:19:48.530Z] # Started: TestTask0 [2025-01-14T09:19:48.530Z] # Started: TestTask1 [2025-01-14T09:19:48.530Z] # Started: TestTask2 [2025-01-14T09:19:48.530Z] # Started: TestTask3 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.530Z] # Started: TestTask4 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.530Z] # Started: TestTask5 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.530Z] # Started: TestTask7 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask8 [2025-01-14T09:19:48.530Z] # Started: TestTask8 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask10 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask11 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.530Z] # Started: TestTask12 [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # main: SetNotifyJvmtiEvents: #6 enable: true [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask13 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask0 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask2 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask3 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask5 [2025-01-14T09:19:48.530Z] # Started: TestTask14 [2025-01-14T09:19:48.530Z] # Started: TestTask6 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.530Z] # Started: TestTask13 [2025-01-14T09:19:48.530Z] # Started: TestTask19 [2025-01-14T09:19:48.530Z] # Started: TestTask18 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.530Z] # Started: TestTask17 [2025-01-14T09:19:48.530Z] # Started: TestTask16 [2025-01-14T09:19:48.530Z] # Started: TestTask15 [2025-01-14T09:19:48.530Z] # Started: TestTask11 [2025-01-14T09:19:48.530Z] # Started: TestTask10 [2025-01-14T09:19:48.530Z] # Started: TestTask9 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask14 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask15 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask17 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.530Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask19 [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # Java: Finished test cycle #6 [2025-01-14T09:19:48.530Z] VirtualThreadStart events: 126 [2025-01-14T09:19:48.530Z] VirtualThreadEnd events: 140 [2025-01-14T09:19:48.530Z] ThreadStart events: 6 [2025-01-14T09:19:48.530Z] ThreadEnd events: 0 [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # Java: Started test cycle #7 [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # main: SetNotifyJvmtiEvents: #7 enable: false [2025-01-14T09:19:48.530Z] [2025-01-14T09:19:48.530Z] # Java: Starting vthreads [2025-01-14T09:19:48.530Z] # Started: TestTask0 [2025-01-14T09:19:48.530Z] # Started: TestTask2 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.530Z] # Started: TestTask3 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.530Z] # Started: TestTask5 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.530Z] # Started: TestTask7 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask4 [2025-01-14T09:19:48.530Z] # Started: TestTask4 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.530Z] # Started: TestTask8 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.530Z] # Started: TestTask9 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.530Z] # Started: TestTask10 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.530Z] # Started: TestTask11 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.530Z] # Started: TestTask12 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask13 [2025-01-14T09:19:48.530Z] # Started: TestTask13 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.530Z] # Started: TestTask14 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.530Z] # Started: TestTask15 [2025-01-14T09:19:48.530Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.530Z] # Started: TestTask16 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.531Z] # Started: TestTask17 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.531Z] # Started: TestTask18 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask6 [2025-01-14T09:19:48.531Z] # Started: TestTask6 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.531Z] # Started: TestTask19 [2025-01-14T09:19:48.531Z] # Started: TestTask1 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # main: SetNotifyJvmtiEvents: #7 enable: true [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask0 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask1 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask5 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask6 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask9 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask11 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask12 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask14 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask19 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # Java: Finished test cycle #7 [2025-01-14T09:19:48.531Z] VirtualThreadStart events: 143 [2025-01-14T09:19:48.531Z] VirtualThreadEnd events: 160 [2025-01-14T09:19:48.531Z] ThreadStart events: 6 [2025-01-14T09:19:48.531Z] ThreadEnd events: 0 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # Java: Started test cycle #8 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # main: SetNotifyJvmtiEvents: #8 enable: false [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # Java: Starting vthreads [2025-01-14T09:19:48.531Z] # Started: TestTask1 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask6 [2025-01-14T09:19:48.531Z] # Started: TestTask6 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.531Z] # Started: TestTask7 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask9 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask10 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask11 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask12 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask13 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask15 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask16 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask17 [2025-01-14T09:19:48.531Z] # Started: TestTask8 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask18 [2025-01-14T09:19:48.531Z] # Started: TestTask18 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask19 [2025-01-14T09:19:48.531Z] # Started: TestTask19 [2025-01-14T09:19:48.531Z] # Started: TestTask5 [2025-01-14T09:19:48.531Z] # Started: TestTask17 [2025-01-14T09:19:48.531Z] # Started: TestTask4 [2025-01-14T09:19:48.531Z] # Started: TestTask3 [2025-01-14T09:19:48.531Z] # Started: TestTask2 [2025-01-14T09:19:48.531Z] # Started: TestTask0 [2025-01-14T09:19:48.531Z] # Started: TestTask16 [2025-01-14T09:19:48.531Z] # Started: TestTask15 [2025-01-14T09:19:48.531Z] # Started: TestTask14 [2025-01-14T09:19:48.531Z] # Started: TestTask13 [2025-01-14T09:19:48.531Z] # Started: TestTask12 [2025-01-14T09:19:48.531Z] # Started: TestTask11 [2025-01-14T09:19:48.531Z] # Started: TestTask10 [2025-01-14T09:19:48.531Z] # Started: TestTask9 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # main: SetNotifyJvmtiEvents: #8 enable: true [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask0 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask2 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask3 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask4 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask5 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask6 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask7 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask13 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask14 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask15 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask16 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask18 [2025-01-14T09:19:48.531Z] Event: VirtualThreadEnd virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # Java: Finished test cycle #8 [2025-01-14T09:19:48.531Z] VirtualThreadStart events: 157 [2025-01-14T09:19:48.531Z] VirtualThreadEnd events: 180 [2025-01-14T09:19:48.531Z] ThreadStart events: 6 [2025-01-14T09:19:48.531Z] ThreadEnd events: 0 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # Java: Started test cycle #9 [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # main: SetNotifyJvmtiEvents: #9 enable: false [2025-01-14T09:19:48.531Z] [2025-01-14T09:19:48.531Z] # Java: Starting vthreads [2025-01-14T09:19:48.531Z] # Started: TestTask0 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask1 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask3 [2025-01-14T09:19:48.531Z] # Started: TestTask1 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask4 [2025-01-14T09:19:48.531Z] # Started: TestTask4 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask5 [2025-01-14T09:19:48.531Z] # Started: TestTask5 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask6 [2025-01-14T09:19:48.531Z] # Started: TestTask6 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask7 [2025-01-14T09:19:48.531Z] # Started: TestTask7 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask8 [2025-01-14T09:19:48.531Z] # Started: TestTask8 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask9 [2025-01-14T09:19:48.531Z] # Started: TestTask9 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask10 [2025-01-14T09:19:48.531Z] # Started: TestTask10 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask11 [2025-01-14T09:19:48.531Z] # Started: TestTask11 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask12 [2025-01-14T09:19:48.531Z] # Started: TestTask12 [2025-01-14T09:19:48.531Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask13 [2025-01-14T09:19:48.531Z] # Started: TestTask13 [2025-01-14T09:19:48.532Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask14 [2025-01-14T09:19:48.532Z] # Started: TestTask14 [2025-01-14T09:19:48.532Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask15 [2025-01-14T09:19:48.532Z] # Started: TestTask15 [2025-01-14T09:19:48.532Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask16 [2025-01-14T09:19:48.532Z] # Started: TestTask16 [2025-01-14T09:19:48.532Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-2 vt: TestTask17 [2025-01-14T09:19:48.532Z] # Started: TestTask17 [2025-01-14T09:19:48.532Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-4 vt: TestTask18 [2025-01-14T09:19:48.532Z] # Started: TestTask18 [2025-01-14T09:19:48.532Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-1 vt: TestTask19 [2025-01-14T09:19:48.532Z] # Started: TestTask19 [2025-01-14T09:19:48.532Z] [2025-01-14T09:19:48.532Z] # main: SetNotifyJvmtiEvents: #9 enable: true [2025-01-14T09:19:48.532Z] Event: VirtualThreadStart virtual: 1 ct: ForkJoinPool-1-worker-3 vt: TestTask2 [2025-01-14T09:19:48.532Z] # Started: TestTask2 [2025-01-14T09:19:48.532Z] STDERR: [2025-01-14T09:19:48.532Z] WARNING: A JVM TI agent has been loaded dynamically (ToggleNotifyJvmtiTest) [2025-01-14T09:19:48.532Z] WARNING: If a serviceability tool is in use, please run with -XX:+EnableDynamicAgentLoading to hide this warning [2025-01-14T09:19:48.532Z] WARNING: Dynamic loading of agents will be disallowed by default in a future release [2025-01-14T09:19:48.532Z] rerun: [2025-01-14T09:19:48.532Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\1' && \ [2025-01-14T09:19:48.532Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.532Z] SystemDrive=C: \ [2025-01-14T09:19:48.532Z] SystemRoot='C:\Windows' \ [2025-01-14T09:19:48.532Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.532Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:19:48.532Z] windir='C:\Windows' \ [2025-01-14T09:19:48.532Z] CLASSPATH='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar' \ [2025-01-14T09:19:48.532Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\java' \ [2025-01-14T09:19:48.532Z] -Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:19:48.532Z] -Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:19:48.532Z] -Dtest.compiler.opts= \ [2025-01-14T09:19:48.532Z] -Dtest.java.opts= \ [2025-01-14T09:19:48.532Z] -Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.532Z] -Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:19:48.532Z] -Dtest.timeout.factor=8.0 \ [2025-01-14T09:19:48.532Z] -Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.532Z] -Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.532Z] -Dtest.name=serviceability/jvmti/vthread/ToggleNotifyJvmtiTest/ToggleNotifyJvmtiTest.java \ [2025-01-14T09:19:48.532Z] -Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.java' \ [2025-01-14T09:19:48.532Z] -Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest' \ [2025-01-14T09:19:48.532Z] -Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:19:48.532Z] -Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d' \ [2025-01-14T09:19:48.532Z] -Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.532Z] -Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\hotspot\jtreg' \ [2025-01-14T09:19:48.532Z] -Dtest.enable.preview=true \ [2025-01-14T09:19:48.532Z] -ea \ [2025-01-14T09:19:48.532Z] -esa \ [2025-01-14T09:19:48.532Z] -Xmx512m \ [2025-01-14T09:19:48.532Z] '-Djava.library.path=C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:19:48.532Z] -XX:+UnlockDiagnosticVMOptions \ [2025-01-14T09:19:48.532Z] -XX:+WhiteBoxAPI \ [2025-01-14T09:19:48.532Z] -Xbootclasspath/a:. \ [2025-01-14T09:19:48.532Z] -Djdk.attach.allowAttachSelf=true \ [2025-01-14T09:19:48.532Z] --enable-preview \ [2025-01-14T09:19:48.532Z] com.sun.javatest.regtest.agent.MainWrapper 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\serviceability\jvmti\vthread\ToggleNotifyJvmtiTest\ToggleNotifyJvmtiTest.d\main.2.jta' attach [2025-01-14T09:19:48.532Z] [2025-01-14T09:19:48.532Z] TEST RESULT: Failed. Unexpected exit from test [exit code: -2147483647] [2025-01-14T09:19:48.532Z] -------------------------------------------------- [2025-01-14T09:20:36.074Z] TEST: serviceability/sa/ClhsdbFindPC.java#xcomp-process [2025-01-14T09:20:36.074Z] TEST JDK: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:36.074Z] ACTION: build -- Passed. Build successful [2025-01-14T09:20:36.074Z] REASON: Named class compiled on demand [2025-01-14T09:20:36.074Z] TIME: 0.39 seconds [2025-01-14T09:20:36.074Z] messages: [2025-01-14T09:20:36.074Z] command: build ClhsdbFindPC [2025-01-14T09:20:36.074Z] reason: Named class compiled on demand [2025-01-14T09:20:36.074Z] started: Tue Jan 14 09:20:17 UTC 2025 [2025-01-14T09:20:36.074Z] Test directory: [2025-01-14T09:20:36.074Z] compile: ClhsdbFindPC [2025-01-14T09:20:36.074Z] finished: Tue Jan 14 09:20:17 UTC 2025 [2025-01-14T09:20:36.074Z] elapsed time (seconds): 0.39 [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:36.074Z] ACTION: compile -- Passed. Compilation successful [2025-01-14T09:20:36.074Z] REASON: .class file out of date or does not exist [2025-01-14T09:20:36.074Z] TIME: 0.389 seconds [2025-01-14T09:20:36.074Z] messages: [2025-01-14T09:20:36.074Z] command: compile C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbFindPC.java [2025-01-14T09:20:36.074Z] reason: .class file out of date or does not exist [2025-01-14T09:20:36.074Z] started: Tue Jan 14 09:20:17 UTC 2025 [2025-01-14T09:20:36.074Z] Mode: agentvm [2025-01-14T09:20:36.074Z] Agent id: 3 [2025-01-14T09:20:36.074Z] finished: Tue Jan 14 09:20:17 UTC 2025 [2025-01-14T09:20:36.074Z] elapsed time (seconds): 0.389 [2025-01-14T09:20:36.074Z] configuration: [2025-01-14T09:20:36.074Z] Boot Layer (javac runtime environment) [2025-01-14T09:20:36.074Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar [2025-01-14T09:20:36.074Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar [2025-01-14T09:20:36.074Z] patch: java.base C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\patches\java.base [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:36.074Z] javac compilation environment [2025-01-14T09:20:36.074Z] source path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa [2025-01-14T09:20:36.074Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib [2025-01-14T09:20:36.074Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa [2025-01-14T09:20:36.074Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d [2025-01-14T09:20:36.074Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:36.074Z] rerun: [2025-01-14T09:20:36.074Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\0' && \ [2025-01-14T09:20:36.074Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps' \ [2025-01-14T09:20:36.074Z] SystemDrive=C: \ [2025-01-14T09:20:36.074Z] SystemRoot='C:\Windows' \ [2025-01-14T09:20:36.074Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:20:36.074Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:20:36.074Z] windir='C:\Windows' \ [2025-01-14T09:20:36.074Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\javac' \ [2025-01-14T09:20:36.074Z] -J-ea \ [2025-01-14T09:20:36.074Z] -J-esa \ [2025-01-14T09:20:36.074Z] -J-Xmx512m \ [2025-01-14T09:20:36.074Z] -J-Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:20:36.074Z] -J-Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:20:36.074Z] -J-Dtest.compiler.opts= \ [2025-01-14T09:20:36.074Z] -J-Dtest.java.opts= \ [2025-01-14T09:20:36.074Z] -J-Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:20:36.074Z] -J-Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:20:36.074Z] -J-Dtest.timeout.factor=8.0 \ [2025-01-14T09:20:36.074Z] -J-Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:20:36.074Z] -J-Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:20:36.074Z] -J-Dtest.name=serviceability/sa/ClhsdbFindPC.java#xcomp-process \ [2025-01-14T09:20:36.074Z] -J-Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbFindPC.java' \ [2025-01-14T09:20:36.074Z] -J-Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa' \ [2025-01-14T09:20:36.074Z] -J-Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib' \ [2025-01-14T09:20:36.074Z] -J-Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d' \ [2025-01-14T09:20:36.074Z] -J-Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib' \ [2025-01-14T09:20:36.074Z] -J-Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib' \ [2025-01-14T09:20:36.074Z] -d 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d' \ [2025-01-14T09:20:36.074Z] -sourcepath 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib' \ [2025-01-14T09:20:36.074Z] -classpath 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib' 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbFindPC.java' [2025-01-14T09:20:36.074Z] direct: [2025-01-14T09:20:36.074Z] Note: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib\jdk\test\lib\Asserts.java uses unchecked or unsafe operations. [2025-01-14T09:20:36.074Z] Note: Recompile with -Xlint:unchecked for details. [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:36.074Z] ACTION: main -- Failed. Execution failed: `main' threw exception: java.lang.RuntimeException: Test ERROR java.lang.RuntimeException: 'In code in NMethod for jdk/test/lib/apps/LingeredApp.steadyState' missing from stdout/stderr [2025-01-14T09:20:36.074Z] REASON: User specified action: run main/othervm/timeout=480 ClhsdbFindPC true false [2025-01-14T09:20:36.074Z] TIME: 10.702 seconds [2025-01-14T09:20:36.074Z] messages: [2025-01-14T09:20:36.074Z] command: main ClhsdbFindPC true false [2025-01-14T09:20:36.074Z] reason: User specified action: run main/othervm/timeout=480 ClhsdbFindPC true false [2025-01-14T09:20:36.074Z] started: Tue Jan 14 09:20:17 UTC 2025 [2025-01-14T09:20:36.074Z] Mode: othervm [/othervm specified] [2025-01-14T09:20:36.074Z] finished: Tue Jan 14 09:20:28 UTC 2025 [2025-01-14T09:20:36.074Z] elapsed time (seconds): 10.702 [2025-01-14T09:20:36.074Z] configuration: [2025-01-14T09:20:36.074Z] STDOUT: [2025-01-14T09:20:36.074Z] Starting the ClhsdbFindPC test [2025-01-14T09:20:36.074Z] Command line: ['C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\java.exe' '-ea' '-esa' '-Xmx512m' '-Xcomp' '-XX:-AlwaysPreTouch' '-cp' 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib' 'jdk.test.lib.apps.LingeredApp' 'e8a1c555-3d16-473e-8b22-f789d410eff7.lck'] [2025-01-14T09:20:36.074Z] LingeredApp startup took 3067ms [2025-01-14T09:20:36.074Z] Check for hs_err_pid/core/mdmp files: [2025-01-14T09:20:36.074Z] None. [2025-01-14T09:20:36.074Z] Started LingeredApp (-Xcomp) with pid 25636 [2025-01-14T09:20:36.074Z] Starting clhsdb against 25636 [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:21.072538Z] Gathering output for process 21596 [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:22.248528200Z] Waiting for completion for process 21596 [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:22.249526400Z] Waiting for completion finished for process 21596 [2025-01-14T09:20:36.074Z] Output: [2025-01-14T09:20:36.074Z] Attaching to process 25636, please wait... [2025-01-14T09:20:36.074Z] hsdb> hsdb> + verbose true [2025-01-14T09:20:36.074Z] hsdb> + jstack -v [2025-01-14T09:20:36.074Z] Deadlock Detection: [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:36.074Z] No deadlocks found. [2025-01-14T09:20:36.074Z] [2025-01-14T09:20:36.074Z] "main" #3 prio=5 tid=0x000001b49f0db1a0 nid=22448 waiting on condition [0x0000002bf58ff000] [2025-01-14T09:20:36.074Z] java.lang.Thread.State: TIMED_WAITING (sleeping) [2025-01-14T09:20:36.074Z] JavaThread state: _thread_blocked [2025-01-14T09:20:36.075Z] - java.lang.Thread.sleepNanos0(long) @bci=0, pc=0x000001b4b118dfd0, Method*=0x000001b4bd040eb8 (Compiled frame; information may be imprecise) [2025-01-14T09:20:36.075Z] - java.lang.Thread.sleepNanos(long) @bci=33, line=482, pc=0x000001b4b0ac4708, Method*=0x000001b4bd040e08 (Interpreted frame) [2025-01-14T09:20:36.075Z] - java.lang.Thread.sleep(long) @bci=25, line=513, pc=0x000001b4a98ab3ec, Method*=0x000001b4bd040fa0 (Compiled frame) [2025-01-14T09:20:36.075Z] - jdk.test.lib.apps.LingeredApp.main(java.lang.String[]) @bci=162, line=637, pc=0x000001b4b0ac4708, Method*=0x000001b4bd503b98 (Interpreted frame) [2025-01-14T09:20:36.075Z] - locked <0x00000000e7db4f80> (a jdk.test.lib.apps.LingeredApp$SteadyStateLock) [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] "Reference Handler" #11 daemon prio=10 tid=0x000001b4b8cb7b10 nid=32312 waiting on condition [0x0000002bf60ff000] [2025-01-14T09:20:36.075Z] java.lang.Thread.State: RUNNABLE [2025-01-14T09:20:36.075Z] JavaThread state: _thread_blocked [2025-01-14T09:20:36.075Z] - java.lang.ref.Reference.processPendingReferences() @bci=0, line=246, pc=0x000001b4b0ac4708, Method*=0x000001b4bd039e48 (Interpreted frame) [2025-01-14T09:20:36.075Z] - java.lang.ref.Reference$ReferenceHandler.run() @bci=8, line=208, pc=0x000001b4b0ac4708, Method*=0x000001b4bd27e248 (Interpreted frame) [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] "Finalizer" #12 daemon prio=8 tid=0x000001b4b8cb9670 nid=50360 in Object.wait() [0x0000002bf61ff000] [2025-01-14T09:20:36.075Z] java.lang.Thread.State: WAITING (on object monitor) [2025-01-14T09:20:36.075Z] JavaThread state: _thread_blocked [2025-01-14T09:20:36.075Z] - java.lang.Object.wait0(long) @bci=0, pc=0x000001b4b0ac8568, Method*=0x000001b4bd000db8 (Interpreted frame) [2025-01-14T09:20:36.075Z] - waiting on <0x00000000e7f09f80> (a java.lang.ref.ReferenceQueue$Lock) [2025-01-14T09:20:36.075Z] - java.lang.Object.wait(long) @bci=55, line=389, pc=0x000001b4b0ac4708, Method*=0x000001b4bd000d00 (Interpreted frame) [2025-01-14T09:20:36.075Z] - java.lang.Object.wait() @bci=2, line=351, pc=0x000001b4b0ac4708, Method*=0x000001b4bd000be0 (Interpreted frame) [2025-01-14T09:20:36.075Z] - java.lang.ref.ReferenceQueue.remove0() @bci=15, line=138, pc=0x000001b4b0ac4708, Method*=0x000001b4bd1a1c68 (Interpreted frame) [2025-01-14T09:20:36.075Z] - java.lang.ref.ReferenceQueue.remove() @bci=8, line=229, pc=0x000001b4b0ac48fc, Method*=0x000001b4bd1a2240 (Interpreted frame) [2025-01-14T09:20:36.075Z] - locked <0x00000000e7f09f80> (a java.lang.ref.ReferenceQueue$Lock) [2025-01-14T09:20:36.075Z] - java.lang.ref.Finalizer$FinalizerThread.run() @bci=20, line=165, pc=0x000001b4b0ac48fc, Method*=0x000001b4bd27f048 (Interpreted frame) [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] "Signal Dispatcher" #13 daemon prio=9 tid=0x000001b4b8cbb4a0 nid=23572 waiting on condition [0x0000000000000000] [2025-01-14T09:20:36.075Z] java.lang.Thread.State: RUNNABLE [2025-01-14T09:20:36.075Z] JavaThread state: _thread_blocked [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] "Common-Cleaner" #21 daemon prio=8 tid=0x000001b4bc89dd90 nid=13528 in Object.wait() [0x0000002bf69ff000] [2025-01-14T09:20:36.075Z] java.lang.Thread.State: TIMED_WAITING (on object monitor) [2025-01-14T09:20:36.075Z] JavaThread state: _thread_blocked [2025-01-14T09:20:36.075Z] - java.lang.Object.wait0(long) @bci=0, pc=0x000001b4b1136b10, Method*=0x000001b4bd000db8 (Compiled frame; information may be imprecise) [2025-01-14T09:20:36.075Z] - waiting on <no object reference available> [2025-01-14T09:20:36.075Z] - java.lang.Object.wait(long) @bci=55, line=389, pc=0x000001b4a97d0d78, Method*=0x000001b4bd000d00 (Compiled frame) [2025-01-14T09:20:36.075Z] - java.lang.ref.ReferenceQueue.remove0(long) @bci=21, line=124, pc=0x000001b4a97ce9cc, Method*=0x000001b4bd1a1b80 (Compiled frame) [2025-01-14T09:20:36.075Z] - java.lang.ref.ReferenceQueue.remove(long) @bci=36, line=215, pc=0x000001b4a97ce06c, Method*=0x000001b4bd1a2150 (Compiled frame) [2025-01-14T09:20:36.075Z] - locked <0x00000000e7d9f9a0> (a java.lang.ref.ReferenceQueue$Lock) [2025-01-14T09:20:36.075Z] - jdk.internal.ref.CleanerImpl.run() @bci=45, line=140, pc=0x000001b4a97cc074, Method*=0x000001b4bd45cd40 (Compiled frame) [2025-01-14T09:20:36.075Z] - java.lang.Thread.runWith(java.lang.Object, java.lang.Runnable) @bci=5, line=1460, pc=0x000001b4a97cb5e0, Method*=0x000001b4bd042818 (Compiled frame) [2025-01-14T09:20:36.075Z] - java.lang.Thread.run() @bci=19, line=1447, pc=0x000001b4a97cb5e0, Method*=0x000001b4bd042730 (Compiled frame) [2025-01-14T09:20:36.075Z] - jdk.internal.misc.InnocuousThread.run() @bci=20, line=148, pc=0x000001b4a97c9d0c, Method*=0x000001b4bd461958 (Compiled frame) [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] "SteadyStateThread" #22 prio=5 tid=0x000001b4bcfe9d40 nid=22820 waiting for monitor entry [0x0000002bf6aff000] [2025-01-14T09:20:36.075Z] java.lang.Thread.State: BLOCKED (on object monitor) [2025-01-14T09:20:36.075Z] JavaThread state: _thread_blocked [2025-01-14T09:20:36.075Z] - jdk.test.lib.apps.LingeredApp.steadyState(java.lang.Object) @bci=0, line=565, pc=0x000001b4a9840208, Method*=0x000001b4bd503818 (Compiled frame; information may be imprecise) [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] Error occurred during stack walking: [2025-01-14T09:20:36.075Z] java.lang.NullPointerException: Cannot invoke "sun.jvm.hotspot.debugger.Address.addOffsetTo(long)" because the return value of "sun.jvm.hotspot.runtime.Frame.getFP()" is null [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.runtime.Frame.addressOfStackSlot(Frame.java:237) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.runtime.aarch64.AARCH64Frame.getSenderSP(AARCH64Frame.java:492) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.runtime.aarch64.AARCH64Frame.sender(AARCH64Frame.java:300) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.runtime.Frame.sender(Frame.java:207) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.runtime.Frame.realSender(Frame.java:212) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.runtime.VFrame.sender(VFrame.java:120) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.runtime.VFrame.javaSender(VFrame.java:150) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.tools.StackTrace.run(StackTrace.java:81) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.CommandProcessor$27.doit(CommandProcessor.java:1162) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.CommandProcessor.executeCommand(CommandProcessor.java:2230) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.CommandProcessor.executeCommand(CommandProcessor.java:2200) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.CommandProcessor.run(CommandProcessor.java:2071) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.CLHSDB.run(CLHSDB.java:112) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.CLHSDB.main(CLHSDB.java:44) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.SALauncher.runCLHSDB(SALauncher.java:285) [2025-01-14T09:20:36.075Z] at jdk.hotspot.agent/sun.jvm.hotspot.SALauncher.main(SALauncher.java:507) [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] hsdb> + quit [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] Starting clhsdb against 25636 [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:22.261530200Z] Gathering output for process 30768 [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:23.372524Z] Waiting for completion for process 30768 [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:23.372524Z] Waiting for completion finished for process 30768 [2025-01-14T09:20:36.075Z] Output: [2025-01-14T09:20:36.075Z] Attaching to process 25636, please wait... [2025-01-14T09:20:36.075Z] hsdb> hsdb> + verbose true [2025-01-14T09:20:36.075Z] hsdb> + findpc 0x000001b4a9840208 [2025-01-14T09:20:36.075Z] Address 0x000001b4a9840208: Is of type nmethod [2025-01-14T09:20:36.075Z] hsdb> + quit [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] LingeredApp stdout: []; [2025-01-14T09:20:36.075Z] LingeredApp stderr: [] [2025-01-14T09:20:36.075Z] LingeredApp exitValue = 0 [2025-01-14T09:20:36.075Z] STDERR: [2025-01-14T09:20:36.075Z] stdout: [ + findpc 0x000001b4a9840208 [2025-01-14T09:20:36.075Z] Address 0x000001b4a9840208: Is of type nmethod [2025-01-14T09:20:36.075Z] ]; [2025-01-14T09:20:36.075Z] stderr: [ + findpc 0x000001b4a9840208 [2025-01-14T09:20:36.075Z] Address 0x000001b4a9840208: Is of type nmethod [2025-01-14T09:20:36.075Z] ] [2025-01-14T09:20:36.075Z] exitValue = -1 [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] java.lang.RuntimeException: Test ERROR java.lang.RuntimeException: 'In code in NMethod for jdk/test/lib/apps/LingeredApp.steadyState' missing from stdout/stderr [2025-01-14T09:20:36.075Z] at ClhsdbFindPC.testFindPC(ClhsdbFindPC.java:315) [2025-01-14T09:20:36.075Z] at ClhsdbFindPC.main(ClhsdbFindPC.java:337) [2025-01-14T09:20:36.075Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:104) [2025-01-14T09:20:36.075Z] at java.base/java.lang.reflect.Method.invoke(Method.java:565) [2025-01-14T09:20:36.075Z] at com.sun.javatest.regtest.agent.MainWrapper$MainTask.run(MainWrapper.java:138) [2025-01-14T09:20:36.075Z] at java.base/java.lang.Thread.run(Thread.java:1447) [2025-01-14T09:20:36.075Z] Caused by: java.lang.RuntimeException: 'In code in NMethod for jdk/test/lib/apps/LingeredApp.steadyState' missing from stdout/stderr [2025-01-14T09:20:36.075Z] at jdk.test.lib.process.OutputAnalyzer.shouldMatch(OutputAnalyzer.java:372) [2025-01-14T09:20:36.075Z] at ClhsdbLauncher.runCmd(ClhsdbLauncher.java:175) [2025-01-14T09:20:36.075Z] at ClhsdbLauncher.run(ClhsdbLauncher.java:212) [2025-01-14T09:20:36.075Z] at ClhsdbFindPC.runTest(ClhsdbFindPC.java:329) [2025-01-14T09:20:36.075Z] at ClhsdbFindPC.testFindPC(ClhsdbFindPC.java:168) [2025-01-14T09:20:36.075Z] ... 5 more [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] JavaTest Message: Test threw exception: java.lang.RuntimeException: Test ERROR java.lang.RuntimeException: 'In code in NMethod for jdk/test/lib/apps/LingeredApp.steadyState' missing from stdout/stderr [2025-01-14T09:20:36.075Z] JavaTest Message: shutting down test [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] STATUS:Failed.`main' threw exception: java.lang.RuntimeException: Test ERROR java.lang.RuntimeException: 'In code in NMethod for jdk/test/lib/apps/LingeredApp.steadyState' missing from stdout/stderr [2025-01-14T09:20:36.075Z] rerun: [2025-01-14T09:20:36.075Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\0' && \ [2025-01-14T09:20:36.075Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps' \ [2025-01-14T09:20:36.075Z] SystemDrive=C: \ [2025-01-14T09:20:36.075Z] SystemRoot='C:\Windows' \ [2025-01-14T09:20:36.075Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:20:36.075Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:20:36.075Z] windir='C:\Windows' \ [2025-01-14T09:20:36.075Z] CLASSPATH='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar' \ [2025-01-14T09:20:36.075Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\java' \ [2025-01-14T09:20:36.075Z] -Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:20:36.075Z] -Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:20:36.075Z] -Dtest.compiler.opts= \ [2025-01-14T09:20:36.075Z] -Dtest.java.opts= \ [2025-01-14T09:20:36.075Z] -Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:20:36.075Z] -Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:20:36.075Z] -Dtest.timeout.factor=8.0 \ [2025-01-14T09:20:36.075Z] -Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:20:36.075Z] -Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:20:36.075Z] -Dtest.name=serviceability/sa/ClhsdbFindPC.java#xcomp-process \ [2025-01-14T09:20:36.075Z] -Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbFindPC.java' \ [2025-01-14T09:20:36.075Z] -Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa' \ [2025-01-14T09:20:36.075Z] -Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib' \ [2025-01-14T09:20:36.075Z] -Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d' \ [2025-01-14T09:20:36.075Z] -Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib' \ [2025-01-14T09:20:36.075Z] -Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\serviceability\sa\ClhsdbFindPC_xcomp-process.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\0\test\lib' \ [2025-01-14T09:20:36.075Z] -ea \ [2025-01-14T09:20:36.075Z] -esa \ [2025-01-14T09:20:36.075Z] -Xmx512m \ [2025-01-14T09:20:36.075Z] '-Djava.library.path=C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:20:36.075Z] com.sun.javatest.regtest.agent.MainWrapper 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\serviceability\sa\ClhsdbFindPC_xcomp-process.d\main.0.jta' true false [2025-01-14T09:20:36.075Z] [2025-01-14T09:20:36.075Z] TEST RESULT: Failed. Execution failed: `main' threw exception: java.lang.RuntimeException: Test ERROR java.lang.RuntimeException: 'In code in NMethod for jdk/test/lib/apps/LingeredApp.steadyState' missing from stdout/stderr [2025-01-14T09:20:36.075Z] -------------------------------------------------- [2025-01-14T09:21:15.593Z] TEST: serviceability/sa/ClhsdbJstackXcompStress.java [2025-01-14T09:21:15.593Z] TEST JDK: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image [2025-01-14T09:21:15.593Z] [2025-01-14T09:21:15.593Z] ACTION: build -- Passed. Build successful [2025-01-14T09:21:15.593Z] REASON: Named class compiled on demand [2025-01-14T09:21:15.593Z] TIME: 0.188 seconds [2025-01-14T09:21:15.593Z] messages: [2025-01-14T09:21:15.593Z] command: build ClhsdbJstackXcompStress [2025-01-14T09:21:15.593Z] reason: Named class compiled on demand [2025-01-14T09:21:15.593Z] started: Tue Jan 14 09:20:42 UTC 2025 [2025-01-14T09:21:15.593Z] Test directory: [2025-01-14T09:21:15.593Z] compile: ClhsdbJstackXcompStress [2025-01-14T09:21:15.593Z] finished: Tue Jan 14 09:20:42 UTC 2025 [2025-01-14T09:21:15.593Z] elapsed time (seconds): 0.188 [2025-01-14T09:21:15.593Z] [2025-01-14T09:21:15.593Z] ACTION: compile -- Passed. Compilation successful [2025-01-14T09:21:15.593Z] REASON: .class file out of date or does not exist [2025-01-14T09:21:15.593Z] TIME: 0.188 seconds [2025-01-14T09:21:15.593Z] messages: [2025-01-14T09:21:15.593Z] command: compile C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbJstackXcompStress.java [2025-01-14T09:21:15.593Z] reason: .class file out of date or does not exist [2025-01-14T09:21:15.593Z] started: Tue Jan 14 09:20:42 UTC 2025 [2025-01-14T09:21:15.593Z] Mode: agentvm [2025-01-14T09:21:15.593Z] Agent id: 2 [2025-01-14T09:21:15.593Z] finished: Tue Jan 14 09:20:42 UTC 2025 [2025-01-14T09:21:15.593Z] elapsed time (seconds): 0.188 [2025-01-14T09:21:15.593Z] configuration: [2025-01-14T09:21:15.593Z] Boot Layer (javac runtime environment) [2025-01-14T09:21:15.593Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar [2025-01-14T09:21:15.593Z] patch: java.base C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\patches\java.base [2025-01-14T09:21:15.593Z] [2025-01-14T09:21:15.593Z] javac compilation environment [2025-01-14T09:21:15.593Z] source path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib [2025-01-14T09:21:15.593Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib [2025-01-14T09:21:15.593Z] [2025-01-14T09:21:15.593Z] rerun: [2025-01-14T09:21:15.593Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\1' && \ [2025-01-14T09:21:15.593Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps' \ [2025-01-14T09:21:15.593Z] SystemDrive=C: \ [2025-01-14T09:21:15.593Z] SystemRoot='C:\Windows' \ [2025-01-14T09:21:15.593Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:21:15.593Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:21:15.593Z] windir='C:\Windows' \ [2025-01-14T09:21:15.593Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\javac' \ [2025-01-14T09:21:15.593Z] -J-ea \ [2025-01-14T09:21:15.593Z] -J-esa \ [2025-01-14T09:21:15.593Z] -J-Xmx512m \ [2025-01-14T09:21:15.593Z] -J-Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:21:15.593Z] -J-Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:21:15.593Z] -J-Dtest.compiler.opts= \ [2025-01-14T09:21:15.593Z] -J-Dtest.java.opts= \ [2025-01-14T09:21:15.593Z] -J-Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:21:15.593Z] -J-Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:21:15.593Z] -J-Dtest.timeout.factor=8.0 \ [2025-01-14T09:21:15.593Z] -J-Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:21:15.593Z] -J-Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:21:15.593Z] -J-Dtest.name=serviceability/sa/ClhsdbJstackXcompStress.java \ [2025-01-14T09:21:15.593Z] -J-Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbJstackXcompStress.java' \ [2025-01-14T09:21:15.593Z] -J-Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa' \ [2025-01-14T09:21:15.593Z] -J-Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib' \ [2025-01-14T09:21:15.593Z] -J-Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d' \ [2025-01-14T09:21:15.593Z] -J-Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib' \ [2025-01-14T09:21:15.593Z] -J-Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib' \ [2025-01-14T09:21:15.593Z] -d 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d' \ [2025-01-14T09:21:15.593Z] -sourcepath 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib' \ [2025-01-14T09:21:15.593Z] -classpath 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib' 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbJstackXcompStress.java' [2025-01-14T09:21:15.593Z] [2025-01-14T09:21:15.593Z] ACTION: driver -- Failed. Execution failed: `main' threw exception: java.lang.RuntimeException: Expected jstack output to contain 'Compiled frame' [2025-01-14T09:21:15.593Z] REASON: User specified action: run driver/timeout=300 ClhsdbJstackXcompStress [2025-01-14T09:21:15.593Z] TIME: 30.49 seconds [2025-01-14T09:21:15.593Z] messages: [2025-01-14T09:21:15.593Z] command: driver ClhsdbJstackXcompStress [2025-01-14T09:21:15.593Z] reason: User specified action: run driver/timeout=300 ClhsdbJstackXcompStress [2025-01-14T09:21:15.593Z] started: Tue Jan 14 09:20:42 UTC 2025 [2025-01-14T09:21:15.593Z] Mode: agentvm [2025-01-14T09:21:15.593Z] Agent id: 24 [2025-01-14T09:21:15.593Z] finished: Tue Jan 14 09:21:13 UTC 2025 [2025-01-14T09:21:15.593Z] elapsed time (seconds): 30.49 [2025-01-14T09:21:15.593Z] configuration: [2025-01-14T09:21:15.593Z] Boot Layer [2025-01-14T09:21:15.593Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\junit-platform-console-standalone-1.10.2.jar [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\testng-7.3.0.jar [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\guice-5.1.0.jar [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jcommander-1.82.jar [2025-01-14T09:21:15.593Z] patch: java.base C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\patches\java.base [2025-01-14T09:21:15.593Z] [2025-01-14T09:21:15.593Z] Test Layer [2025-01-14T09:21:15.593Z] class path: C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib [2025-01-14T09:21:15.593Z] C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib [2025-01-14T09:21:15.593Z] [2025-01-14T09:21:15.593Z] rerun: [2025-01-14T09:21:15.593Z] cd 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\scratch\1' && \ [2025-01-14T09:21:15.593Z] PATH='C:\cygwin64\bin;C:\Windows\system32;C:\Windows;C:\Windows\System32\Wbem;C:\Windows\System32\WindowsPowerShell\v1.0;C:\Windows\System32\OpenSSH;C:\Users\adoptopenjdk\AppData\Local\Microsoft\WindowsApps;C:\Strawberry\perl\bin;C:\Program Files\Git\cmd;C:\openjdk\jdk-11\bin;C:\apache-ant\apache-ant-1.10.15\bin;C:\Program Files (x86)\IncrediBuild;C:\rust\bin;C:\Program Files\IcedTeaWEB\bin;C:\cygwin64\bin;C:\Users\jenkins\AppData\Local\Microsoft\WindowsApps' \ [2025-01-14T09:21:15.593Z] SystemDrive=C: \ [2025-01-14T09:21:15.593Z] SystemRoot='C:\Windows' \ [2025-01-14T09:21:15.593Z] TEMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:21:15.593Z] TMP='C:\Users\jenkins\AppData\Local\Temp' \ [2025-01-14T09:21:15.593Z] windir='C:\Windows' \ [2025-01-14T09:21:15.593Z] 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\java' \ [2025-01-14T09:21:15.593Z] -Dtest.vm.opts='-ea -esa -Xmx512m' \ [2025-01-14T09:21:15.593Z] -Dtest.tool.vm.opts='-J-ea -J-esa -J-Xmx512m' \ [2025-01-14T09:21:15.593Z] -Dtest.compiler.opts= \ [2025-01-14T09:21:15.593Z] -Dtest.java.opts= \ [2025-01-14T09:21:15.593Z] -Dtest.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:21:15.593Z] -Dcompile.jdk='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image' \ [2025-01-14T09:21:15.593Z] -Dtest.timeout.factor=8.0 \ [2025-01-14T09:21:15.593Z] -Dtest.nativepath='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\openjdk-test-image\hotspot\jtreg\native' \ [2025-01-14T09:21:15.593Z] -Dtest.root='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg' \ [2025-01-14T09:21:15.593Z] -Dtest.name=serviceability/sa/ClhsdbJstackXcompStress.java \ [2025-01-14T09:21:15.593Z] -Dtest.file='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa\ClhsdbJstackXcompStress.java' \ [2025-01-14T09:21:15.593Z] -Dtest.src='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa' \ [2025-01-14T09:21:15.593Z] -Dtest.src.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib' \ [2025-01-14T09:21:15.593Z] -Dtest.classes='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d' \ [2025-01-14T09:21:15.593Z] -Dtest.class.path='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib' \ [2025-01-14T09:21:15.593Z] -Dtest.class.path.prefix='C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib' \ [2025-01-14T09:21:15.593Z] -classpath 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\hotspot\jtreg\serviceability\sa;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\openjdk\openjdk-jdk\test\lib;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\javatest.jar;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jvmtest\openjdk\jtreg\lib\jtreg.jar' \ [2025-01-14T09:21:15.593Z] ClhsdbJstackXcompStress [2025-01-14T09:21:15.593Z] STDOUT: [2025-01-14T09:21:15.593Z] Command line: ['C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\jdkbinary\j2sdk-image\bin\java.exe' '-ea' '-esa' '-Xmx512m' '-Xcomp' '-XX:CompileCommand=dontinline,LingeredAppWithRecComputation.factorial' '-XX:CompileCommand=compileonly,LingeredAppWithRecComputation.testLoop' '-XX:CompileCommand=compileonly,LingeredAppWithRecComputation.factorial' '-cp' 'C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\serviceability\sa\ClhsdbJstackXcompStress.d;C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work\classes\2\test\lib' 'LingeredAppWithRecComputation' 'd029ac89-6221-4a2b-832c-ff028af3de21.lck'] [2025-01-14T09:21:15.593Z] LingeredApp startup took 1023ms [2025-01-14T09:21:15.593Z] Check for hs_err_pid/core/mdmp files: [2025-01-14T09:21:15.594Z] None. [2025-01-14T09:21:15.594Z] Started LingeredAppWithRecComputation with pid 18280 [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:43.680943600Z] Gathering output for process 5536 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:44.932948300Z] Gathering output for process 39948 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:46.217939500Z] Gathering output for process 33232 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:47.585932800Z] Gathering output for process 37116 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:48.808923800Z] Gathering output for process 48380 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:50.162923200Z] Gathering output for process 12756 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:51.467931100Z] Gathering output for process 18180 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:52.726923Z] Gathering output for process 18476 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:54.352918700Z] Gathering output for process 45160 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:55.963913200Z] Gathering output for process 19672 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:57.779914300Z] Gathering output for process 45972 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:20:59.286903800Z] Gathering output for process 23820 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:00.478902500Z] Gathering output for process 55788 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:01.993899100Z] Gathering output for process 45380 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:03.703899500Z] Gathering output for process 26860 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:04.903898400Z] Gathering output for process 17620 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:06.337900600Z] Gathering output for process 52416 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:07.646888700Z] Gathering output for process 12416 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:09.192884800Z] Gathering output for process 17808 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:10.626880500Z] Gathering output for process 34844 [2025-01-14T09:21:15.594Z] DEBUG: [] [2025-01-14T09:21:15.594Z] LingeredApp stdout: [CompileCommand: dontinline LingeredAppWithRecComputation.factorial bool dontinline = true [2025-01-14T09:21:15.594Z] CompileCommand: compileonly LingeredAppWithRecComputation.testLoop bool compileonly = true [2025-01-14T09:21:15.594Z] CompileCommand: compileonly LingeredAppWithRecComputation.factorial bool compileonly = true [2025-01-14T09:21:15.594Z] ]; [2025-01-14T09:21:15.594Z] LingeredApp stderr: [] [2025-01-14T09:21:15.594Z] LingeredApp exitValue = 0 [2025-01-14T09:21:15.594Z] STDERR: [2025-01-14T09:21:15.594Z] java.lang.RuntimeException: Expected jstack output to contain 'Compiled frame' [2025-01-14T09:21:15.594Z] at ClhsdbJstackXcompStress.runJstackInLoop(ClhsdbJstackXcompStress.java:84) [2025-01-14T09:21:15.594Z] at ClhsdbJstackXcompStress.main(ClhsdbJstackXcompStress.java:100) [2025-01-14T09:21:15.594Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:104) [2025-01-14T09:21:15.594Z] at java.base/java.lang.reflect.Method.invoke(Method.java:565) [2025-01-14T09:21:15.594Z] at com.sun.javatest.regtest.agent.MainActionHelper$AgentVMRunnable.run(MainActionHelper.java:333) [2025-01-14T09:21:15.594Z] at java.base/java.lang.Thread.run(Thread.java:1447) [2025-01-14T09:21:15.594Z] java.lang.RuntimeException: Expected jstack output to contain 'Compiled frame' [2025-01-14T09:21:15.594Z] at ClhsdbJstackXcompStress.runJstackInLoop(ClhsdbJstackXcompStress.java:84) [2025-01-14T09:21:15.594Z] at ClhsdbJstackXcompStress.main(ClhsdbJstackXcompStress.java:100) [2025-01-14T09:21:15.594Z] at java.base/jdk.internal.reflect.DirectMethodHandleAccessor.invoke(DirectMethodHandleAccessor.java:104) [2025-01-14T09:21:15.594Z] at java.base/java.lang.reflect.Method.invoke(Method.java:565) [2025-01-14T09:21:15.594Z] at com.sun.javatest.regtest.agent.MainActionHelper$AgentVMRunnable.run(MainActionHelper.java:333) [2025-01-14T09:21:15.594Z] at java.base/java.lang.Thread.run(Thread.java:1447) [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:15.594Z] JavaTest Message: Test threw exception: java.lang.RuntimeException [2025-01-14T09:21:15.594Z] JavaTest Message: shutting down test [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:15.594Z] [2025-01-14T09:21:15.594Z] TEST RESULT: Failed. Execution failed: `main' threw exception: java.lang.RuntimeException: Expected jstack output to contain 'Compiled frame' [2025-01-14T09:21:15.594Z] -------------------------------------------------- [2025-01-14T09:22:53.106Z] Test results: passed: 348; failed: 3 [2025-01-14T09:23:15.727Z] Report written to C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\report\html\report.html [2025-01-14T09:23:15.727Z] Results written to C:\Users\jenkins\workspace\Test_openjdk25_hs_extended.openjdk_aarch64_windows\aqa-tests\TKG\output_1736833830563\hotspot_serviceability_0\work [2025-01-14T09:23:15.727Z] Error: Some tests failed or other problems occurred. [2025-01-14T09:23:15.727Z] ----------------------------------- [2025-01-14T09:23:15.727Z] hotspot_serviceability_0_FAILED [2025-01-14T09:23:15.727Z] ----------------------------------- [2025-01-14T09:23:15.727Z] [2025-01-14T09:23:15.727Z] TEST TEARDOWN: [2025-01-14T09:23:15.727Z] Nothing to be done for teardown. [2025-01-14T09:23:15.727Z] hotspot_serviceability_0 Finish Time: Tue Jan 14 09:23:13 2025 Epoch Time (ms): 1736846593120