jmeter-dev mailing list archives

Site index · List index
Message view « Date » · « Thread »
Top « Date » · « Thread »
From Apache Jenkins Server <jenk...@builds.apache.org>
Subject Build failed in Jenkins: JMeter Windows #1568
Date Thu, 07 Nov 2019 09:53:29 GMT
See <https://builds.apache.org/job/JMeter%20Windows/1568/display/redirect?page=changes>

Changes:

[sitnikov.vladimir] Update release plugins to 1.40.0: better properties validation and fix

[sitnikov.vladimir] Validate presence of signing.gnupg.keyName when useGpgCmd is used


------------------------------------------
[...truncated 203.91 KB...]
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\Http4ImplPreemptiveBasicAuth.jmx
Starting standalone test @ Thu Nov 07 01:51:11 PST 2019 (1573120271139)
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445
summary =     12 in 00:00:04 =    2.9/s Avg:    71 Min:    26 Max:   489 Err:     0 (0.00%)
Tidying up ...    @ Thu Nov 07 01:51:15 PST 2019 (1573120275929)
... end of run
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\Http4ImplPreemptiveBasicAuth.log
(the file is empty)

> Task :src:dist-check:batchJDBC_TESTS
Nov 07, 2019 1:51:18 AM java.util.prefs.WindowsPreferences <init>
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\JDBC_TESTS.jmx
Starting standalone test @ Thu Nov 07 01:51:18 PST 2019 (1573120278486)
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445
summary =     27 in 00:00:01 =   24.5/s Avg:    19 Min:     0 Max:   489 Err:     0 (0.00%)
Tidying up ...    @ Thu Nov 07 01:51:20 PST 2019 (1573120280688)
... end of run
WARNING: the task was configured to ignore errors in the output log
Logfile contents (errors during the test, see F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\JDBC_TESTS.log):
2019-11-07 01:51:20,652 ERROR o.a.j.t.JMeterThread: Error while processing sampler: 'JDBC_With_Failing_PreProcessor'.
java.lang.IllegalArgumentException: Variable Name must not be null in JDBC PreProcessor
	at org.apache.jmeter.protocol.jdbc.processor.AbstractJDBCProcessor.process(AbstractJDBCProcessor.java:45)
~[ApacheJMeter_jdbc.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.protocol.jdbc.processor.JDBCPreProcessor.process(JDBCPreProcessor.java:33)
~[ApacheJMeter_jdbc.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.runPreProcessors(JMeterThread.java:941) ~[ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.executeSamplePackage(JMeterThread.java:542) ~[ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.processSampler(JMeterThread.java:490) [ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.run(JMeterThread.java:257) [ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at java.lang.Thread.run(Thread.java:748) [?:1.8.0_152]
2019-11-07 01:51:20,664 ERROR o.a.j.t.JMeterThread: Error while processing sampler: 'JDBC_With_Failing_PostProcessor'.
java.lang.IllegalArgumentException: Variable Name must not be null in JDBC PostProcessor
	at org.apache.jmeter.protocol.jdbc.processor.AbstractJDBCProcessor.process(AbstractJDBCProcessor.java:45)
~[ApacheJMeter_jdbc.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.protocol.jdbc.processor.JDBCPostProcessor.process(JDBCPostProcessor.java:33)
~[ApacheJMeter_jdbc.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.runPostProcessors(JMeterThread.java:931) ~[ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.executeSamplePackage(JMeterThread.java:569) ~[ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.processSampler(JMeterThread.java:490) [ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at org.apache.jmeter.threads.JMeterThread.run(JMeterThread.java:257) [ApacheJMeter_core.jar:5.2-SNAPSHOT]
	at java.lang.Thread.run(Thread.java:748) [?:1.8.0_152]
2019-11-07 01:51:20,665 WARN o.a.j.p.j.p.AbstractJDBCProcessor: SQL Problem in JDBC PreProcessor:
java.sql.SQLSyntaxErrorException: unexpected token: USERS
2019-11-07 01:51:20,671 WARN o.a.j.p.j.p.AbstractJDBCProcessor: SQL Problem in JDBC PostProcessor:
java.sql.SQLSyntaxErrorException: unexpected token: USERS

> Task :src:dist-check:batchJMS_TESTS
Nov 07, 2019 1:51:22 AM java.util.prefs.WindowsPreferences <init>
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\JMS_TESTS.jmx
Starting standalone test @ Thu Nov 07 01:51:22 PST 2019 (1573120282820)
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445
summary +     11 in 00:00:07 =    1.5/s Avg:   340 Min:     1 Max:  2003 Err:     0 (0.00%)
Active: 1 Started: 1 Finished: 0
summary +     16 in 00:00:22 =    0.7/s Avg:   698 Min:     0 Max:  3000 Err:     0 (0.00%)
Active: 0 Started: 1 Finished: 1
summary =     27 in 00:00:29 =    0.9/s Avg:   552 Min:     0 Max:  3000 Err:     0 (0.00%)
Tidying up ...    @ Thu Nov 07 01:51:52 PST 2019 (1573120312709)
... end of run
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\JMS_TESTS.log
(the file is empty)

> Task :src:dist-check:batchOS_TESTS
Nov 07, 2019 1:51:55 AM java.util.prefs.WindowsPreferences <init>
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\OS_TESTS.jmx
Starting standalone test @ Thu Nov 07 01:51:55 PST 2019 (1573120315649)
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445
summary =      3 in 00:00:02 =    1.7/s Avg:   389 Min:    67 Max:  1026 Err:     0 (0.00%)
Tidying up ...    @ Thu Nov 07 01:51:57 PST 2019 (1573120317637)
... end of run
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\OS_TESTS.log
(the file is empty)

> Task :src:dist-check:batchResponseDecompression
Nov 07, 2019 1:51:59 AM java.util.prefs.WindowsPreferences <init>
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\ResponseDecompression.jmx
Starting standalone test @ Thu Nov 07 01:51:59 PST 2019 (1573120319757)
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445
summary +      1 in 00:00:01 =    1.1/s Avg:   699 Min:   699 Max:   699 Err:     0 (0.00%)
Active: 1 Started: 1 Finished: 0
summary +      1 in 00:00:01 =    1.4/s Avg:   168 Min:   168 Max:   168 Err:     0 (0.00%)
Active: 0 Started: 1 Finished: 1
summary =      2 in 00:00:02 =    1.2/s Avg:   433 Min:   168 Max:   699 Err:     0 (0.00%)
Tidying up ...    @ Thu Nov 07 01:52:02 PST 2019 (1573120322023)
... end of run
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\ResponseDecompression.log
(the file is empty)
[server] Created remote object: UnicastServerRef2 [liveRef: [endpoint:[jenkins-win-he-de-5.apache.org:50819,SSLRMIServerSocketFactory(host=jenkins-win-he-de-5.apache.org/176.9.73.62,
keyStoreLocation=rmi_keystore.jks, type=JKS, trustStoreLocation=rmi_keystore.jks, type=JKS,
alias=rmi),SSLRMIClientSocketFactory(keyStoreLocation=rmi_keystore.jks, type=JKS, trustStoreLocation=rmi_keystore.jks,
type=JKS, alias=rmi)](local),objID:[2863a1ed:16e45473187:-7fff, 4503356810964598058]]][server]


> Task :src:dist-check:batchServerBatchTestLocal
Nov 07, 2019 1:52:07 AM java.util.prefs.WindowsPreferences <init>
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\BatchTestLocal.jmx
Configuring remote engine: jenkins-win-he-de-5.apache.org:50814
Starting distributed test with remote engines: [jenkins-win-he-de-5.apache.org:50814] @ Thu
Nov 07 01:52:08 PST 2019 (1573120328023)

[server] Starting the test on host jenkins-win-he-de-5.apache.org:50814 @ Thu Nov 07 01:52:11
PST 2019 (1573120331189)

> Task :src:dist-check:batchServerBatchTestLocal
Remote engines have been started:[jenkins-win-he-de-5.apache.org:50814]
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445

> Task :src:dist:javadocAggregate
9 warnings

[server] Nov 07, 2019 1:52:11 AM java.util.prefs.WindowsPreferences <init>
[server] WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
[server] Finished the test on host jenkins-win-he-de-5.apache.org:50814 @ Thu Nov 07 01:52:18
PST 2019 (1573120338531) - exit requested.

> Task :src:dist-check:batchServerBatchTestLocal
summary =    132 in 00:00:07 =   19.4/s Avg:     4 Min:     0 Max:    86 Err:    16 (12.12%)
Tidying up remote @ Thu Nov 07 01:52:18 PST 2019 (1573120338531)

> Task :src:dist:distTar
> Task :src:dist:distTarSha512

> Task :src:dist-check:batchServerBatchTestLocal
... end of run
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\BatchTestLocal.log
(the file is empty)
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\BatchTestLocalServer.log
(the file is empty)

> Task :src:dist-check:batchSlowCharsFeatureHttpClient4
Nov 07, 2019 1:52:25 AM java.util.prefs.WindowsPreferences <init>
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\SlowCharsFeature.jmx
Starting standalone test @ Thu Nov 07 01:52:25 PST 2019 (1573120345777)
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445

> Task :src:dist:distZip
> Task :src:dist:distZipSha512
> Task :src:dist:distZipSourceSha512

> Task :src:dist-check:batchSlowCharsFeatureHttpClient4
summary +      2 in 00:00:06 =    0.3/s Avg:  2996 Min:   352 Max:  5640 Err:     0 (0.00%)
Active: 1 Started: 1 Finished: 0

> Task :src:dist:processSiteXslt
> Task :src:dist:previewSite UP-TO-DATE
> Task :src:dist:signDistTar SKIPPED
> Task :src:dist:signDistTarSource SKIPPED
> Task :src:dist:signDistZip SKIPPED
> Task :src:dist:signDistZipSource SKIPPED
> Task :src:dist:assemble

> Task :src:dist-check:batchSlowCharsFeatureHttpClient4
summary +      3 in 00:00:30 =    0.1/s Avg:  9982 Min:  5594 Max: 13949 Err:     0 (0.00%)
Active: 1 Started: 1 Finished: 0
summary =      5 in 00:00:36 =    0.1/s Avg:  7188 Min:   352 Max: 13949 Err:     0 (0.00%)
summary =      5 in 00:00:36 =    0.1/s Avg:  7188 Min:   352 Max: 13949 Err:     0 (0.00%)
Tidying up ...    @ Thu Nov 07 01:53:02 PST 2019 (1573120382632)
... end of run
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\SlowCharsFeature.log
(the file is empty)

> Task :src:dist-check:batchSlowCharsFeatureJava
Nov 07, 2019 1:53:04 AM java.util.prefs.WindowsPreferences <init>
WARNING: Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002.
Windows RegCreateKeyEx(...) returned error code 5.
Creating summariser <summary>
Created the tree successfully using F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\SlowCharsFeature.jmx
Starting standalone test @ Thu Nov 07 01:53:04 PST 2019 (1573120384983)
Waiting for possible Shutdown/StopTestNow/HeapDump/ThreadDump message on port 4445
summary +      1 in 00:00:00 =    2.2/s Avg:   422 Min:   422 Max:   422 Err:     0 (0.00%)
Active: 1 Started: 1 Finished: 0
summary +      3 in 00:00:22 =    0.1/s Avg:  7210 Min:  5596 Max: 10280 Err:     1 (33.33%)
Active: 0 Started: 1 Finished: 1
summary =      4 in 00:00:23 =    0.2/s Avg:  5513 Min:   422 Max: 10280 Err:     1 (25.00%)
Tidying up ...    @ Thu Nov 07 01:53:27 PST 2019 (1573120407927)
... end of run
ERROR: unexpected output for SlowCharsFeature_Java.csv:
  - expected 332 bytes, F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\SlowCharsFeature_Java.csv
  + actual 411 bytes, F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\SlowCharsFeature_Java.csv
@@ -1,5 +1,5 @@
 label,responseCode,responseMessage,threadName,dataType,success
 JSS_setCPS,200,OK,setUp Thread Group 1-1,text,true
-ApacheJMeter-HP-Secure,206,Partial Content,Thread Group 1-1,text,true
+ApacheJMeter-HP-Secure,Non HTTP response code: java.net.SocketTimeoutException,Non HTTP response
message: Read timed out,Thread Group 1-1,text,false
 HTTPS-SNI-without-timeout,206,Partial Content,Thread Group 1-1,text,true
 HTTPS-SNI-with-timeout,206,Partial Content,Thread Group 1-1,text,true
ERROR: unexpected output for SlowCharsFeature_Java.xml:
  - expected 2834 bytes, F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\SlowCharsFeature_Java.xml
  + actual 3332 bytes, F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\SlowCharsFeature_Java.xml
@@ -1,7 +1,7 @@
 <?xml version="1.0" encoding="UTF-8"?>
 <testResults version="1.2">
 <sample s="true" lb="JSS_setCPS" rc="200" rm="OK" tn="setUp Thread Group 1-1" dt="text"/>
-<httpSample s="true" lb="ApacheJMeter-HP-Secure" rc="206" rm="Partial Content" tn="Thread
Group 1-1" dt="text">
+<httpSample s="false" lb="ApacheJMeter-HP-Secure" rc="Non HTTP response code: java.net.SocketTimeoutException"
rm="Non HTTP response message: Read timed out" tn="Thread Group 1-1" dt="text">
   <assertionResult>
     <name>JSA-CheckResponseTimeHigherThan5s</name>
     <failure>false</failure>
@@ -9,23 +9,33 @@
   </assertionResult>
   <assertionResult>
     <name>RA_Size</name>
-    <failure>false</failure>
+    <failure>true</failure>
     <error>false</error>
+    <failureMessage>The result was the wrong size: It was 1,855 bytes, but should have
been equal to 7,001 bytes.</failureMessage>
   </assertionResult>
   <assertionResult>
     <name>RA_206</name>
-    <failure>false</failure>
+    <failure>true</failure>
     <error>false</error>
+    <failureMessage>Test failed: code expected to equal /
+
+****** received  : [[[Non HTTP response code: java.net.SocketTimeoutException]]]
+
+****** comparison: [[[206                                                    ]]]
+
+/</failureMessage>
   </assertionResult>
   <assertionResult>
     <name>RA_PartialContent</name>
-    <failure>false</failure>
+    <failure>true</failure>
     <error>false</error>
+    <failureMessage>Response was null</failureMessage>
   </assertionResult>
   <assertionResult>
     <name>RA</name>
-    <failure>false</failure>
+    <failure>true</failure>
     <error>false</error>
+    <failureMessage>Test failed: text expected to contain /Apache JMeter/</failureMessage>
   </assertionResult>
 </httpSample>
 <httpSample s="true" lb="HTTPS-SNI-without-timeout" rc="206" rm="Partial Content" tn="Thread
Group 1-1" dt="text">
No errors present in the logfile F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\SlowCharsFeature.log
(the file is empty)

> Task :src:dist-check:batchSlowCharsFeatureJava FAILED
checksum-dependency elapsed time: 115845ms, configurations processed: 269
    SHA-512 computation time: 575ms (goes in parallel, it might exceed wall-clock time), files
processed: 44, processed: 6MiB, skipped: 3421MiB
    PGP signature resolution time: 33393ms (wall-clock), resolution requests: 160, signatures
resolved: 225
    PGP key resolution time: 13657ms (wall-clock), resolution requests: 160, download time:
1289ms (goes in parallel, it might exceed wall-clock time), keys downloaded: 1
        PGP signature verification time: 16875ms (goes in parallel, it might exceed wall-clock
time), files processed: 455, processed: 452MiB, skipped: 2946MiB

FAILURE: Build failed with an exception.

* What went wrong:
Execution failed for task ':src:dist-check:batchSlowCharsFeatureJava'.
> Failures detected while testing F:\jenkins\jenkins-slave\workspace\JMeter Windows\bin\testfiles\SlowCharsFeature.jmx:
[unexpected output SlowCharsFeature_Java.csv, unexpected output SlowCharsFeature_Java.xml]

* Try:
Run with --stacktrace option to get the stack trace. Run with --info or --debug option to
get more log output. Run with --scan to get full insights.

* Get more help at https://help.gradle.org

Deprecated Gradle features were used in this build, making it incompatible with Gradle 6.0.
Use '--warning-mode all' to show the individual deprecation warnings.
See https://docs.gradle.org/5.6.2/userguide/command_line_interface.html#sec:command_line_warnings

BUILD FAILED in 6m 56s
290 actionable tasks: 175 executed, 115 up-to-date
Could not open/create prefs root node Software\JavaSoft\Prefs at root 0x80000002. Windows
RegCreateKeyEx(...) returned error code 5.
Build step 'Invoke Gradle script' changed build result to FAILURE
Build step 'Invoke Gradle script' marked build as failure

Mime
View raw message