Bug#844088: conversant-disruptor: FTBFS randomly (failing tests)

Santiago Vila sanvila at debian.org
Sat Nov 12 11:01:01 UTC 2016


Package: src:conversant-disruptor
Version: 1.2.8-1
Severity: serious

Dear maintainer:

I tried to build this package in stretch with "dpkg-buildpackage -A"
(which is what the "Arch: all" autobuilder would do to build it)
but it failed:

--------------------------------------------------------------------------------
[...]
 debian/rules build-indep
dh build-indep
   dh_testdir -i
   dh_update_autotools_config -i
   dh_autoreconf -i
   dh_auto_configure -i
find: '/usr/share/maven-repo/org/codehaus/plexus/plexus-compiler/*/*.jar': No such file or directory
find: '/usr/share/maven-repo/org/codehaus/plexus/plexus-compilers/*/*.jar': No such file or directory
find: '/usr/share/maven-repo/org/codehaus/plexus/plexus-containers/*/*.jar': No such file or directory
	mh_patchpoms -plibconversant-disruptor-java --debian-build --keep-pom-version --maven-repo=/<<PKGBUILDDIR>>/debian/maven-repo
   dh_auto_build -i
	/usr/lib/jvm/default-java/bin/java -noverify -cp /usr/share/maven/boot/plexus-classworlds-2.x.jar:/usr/lib/jvm/default-java/lib/tools.jar -Dmaven.home=/usr/share/maven -Dmaven.multiModuleProjectDirectory=/<<PKGBUILDDIR>> -Dclassworlds.conf=/etc/maven/m2-debian.conf -Dproperties.file.manual=/<<PKGBUILDDIR>>/debian/maven.properties org.codehaus.plexus.classworlds.launcher.Launcher -s/etc/maven/settings-debian.xml -Ddebian.dir=/<<PKGBUILDDIR>>/debian -Dmaven.repo.local=/<<PKGBUILDDIR>>/debian/maven-repo package -DskipTests -Dnotimestamp=true -Dlocale=en_US
[INFO] Scanning for projects...
[INFO]                                                                         
[INFO] ------------------------------------------------------------------------
[INFO] Building com.conversantmedia:disruptor 1.2.8
[INFO] ------------------------------------------------------------------------
[INFO] 
[INFO] --- maven-resources-plugin:2.6:resources (default-resources) @ disruptor ---
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] Copying 2 resources
[INFO] 
[INFO] --- maven-compiler-plugin:3.2:compile (default-compile) @ disruptor ---
[INFO] Changes detected - recompiling the module!
[INFO] Compiling 23 source files to /<<PKGBUILDDIR>>/target/classes
[INFO] /<<PKGBUILDDIR>>/src/main/java/com/conversantmedia/util/concurrent/PushPullConcurrentQueue.java: Some input files use unchecked or unsafe operations.
[INFO] /<<PKGBUILDDIR>>/src/main/java/com/conversantmedia/util/concurrent/PushPullConcurrentQueue.java: Recompile with -Xlint:unchecked for details.
[INFO] 
[INFO] --- maven-resources-plugin:2.6:testResources (default-testResources) @ disruptor ---
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] skip non existing resourceDirectory /<<PKGBUILDDIR>>/src/test/resources
[INFO] 
[INFO] --- maven-compiler-plugin:3.2:testCompile (default-testCompile) @ disruptor ---
[INFO] Changes detected - recompiling the module!
[INFO] Compiling 21 source files to /<<PKGBUILDDIR>>/target/test-classes
[INFO] /<<PKGBUILDDIR>>/src/test/java/com/conversantmedia/util/estimation/PercentileTest.java: /<<PKGBUILDDIR>>/src/test/java/com/conversantmedia/util/estimation/PercentileTest.java uses or overrides a deprecated API.
[INFO] /<<PKGBUILDDIR>>/src/test/java/com/conversantmedia/util/estimation/PercentileTest.java: Recompile with -Xlint:deprecation for details.
[INFO] /<<PKGBUILDDIR>>/src/test/java/com/conversantmedia/util/concurrent/PushPullBlockingQueueTest.java: Some input files use unchecked or unsafe operations.
[INFO] /<<PKGBUILDDIR>>/src/test/java/com/conversantmedia/util/concurrent/PushPullBlockingQueueTest.java: Recompile with -Xlint:unchecked for details.
[INFO] 
[INFO] --- maven-surefire-plugin:2.17:test (default-test) @ disruptor ---
[INFO] Tests are skipped.
[INFO] 
[INFO] --- maven-jar-plugin:2.4:jar (default-jar) @ disruptor ---
[INFO] Building jar: /<<PKGBUILDDIR>>/target/disruptor-1.2.8.jar
[INFO] ------------------------------------------------------------------------
[INFO] BUILD SUCCESS
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 5.554 s
[INFO] Finished at: 2016-11-12T05:43:34+01:00
[INFO] Final Memory: 14M/46M
[INFO] ------------------------------------------------------------------------
   dh_auto_test -i
	/usr/lib/jvm/default-java/bin/java -noverify -cp /usr/share/maven/boot/plexus-classworlds-2.x.jar:/usr/lib/jvm/default-java/lib/tools.jar -Dmaven.home=/usr/share/maven -Dmaven.multiModuleProjectDirectory=/<<PKGBUILDDIR>> -Dclassworlds.conf=/etc/maven/m2-debian.conf -Dproperties.file.manual=/<<PKGBUILDDIR>>/debian/maven.properties org.codehaus.plexus.classworlds.launcher.Launcher -s/etc/maven/settings-debian.xml -Ddebian.dir=/<<PKGBUILDDIR>>/debian -Dmaven.repo.local=/<<PKGBUILDDIR>>/debian/maven-repo test
[INFO] Scanning for projects...
[INFO]                                                                         
[INFO] ------------------------------------------------------------------------
[INFO] Building com.conversantmedia:disruptor 1.2.8
[INFO] ------------------------------------------------------------------------
[INFO] 
[INFO] --- maven-resources-plugin:2.6:resources (default-resources) @ disruptor ---
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] Copying 2 resources
[INFO] 
[INFO] --- maven-compiler-plugin:3.2:compile (default-compile) @ disruptor ---
[INFO] Nothing to compile - all classes are up to date
[INFO] 
[INFO] --- maven-resources-plugin:2.6:testResources (default-testResources) @ disruptor ---
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] skip non existing resourceDirectory /<<PKGBUILDDIR>>/src/test/resources
[INFO] 
[INFO] --- maven-compiler-plugin:3.2:testCompile (default-testCompile) @ disruptor ---
[INFO] Nothing to compile - all classes are up to date
[INFO] 
[INFO] --- maven-surefire-plugin:2.17:test (default-test) @ disruptor ---
[INFO] Surefire report directory: /<<PKGBUILDDIR>>/target/surefire-reports

-------------------------------------------------------
 T E S T S
-------------------------------------------------------
Running com.conversantmedia.util.collection.FixedStackTest
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.164 sec - in com.conversantmedia.util.collection.FixedStackTest
Running com.conversantmedia.util.estimation.PercentileTest
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.086 sec - in com.conversantmedia.util.estimation.PercentileTest
Running com.conversantmedia.util.concurrent.DisruptorPerformanceTest
Tests run: 1, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 0.004 sec - in com.conversantmedia.util.concurrent.DisruptorPerformanceTest
Running com.conversantmedia.util.concurrent.ConcurrentStackPerformanceTest
1000 in 11.0 ms: 11044 ns
1000 in 5.9 ms: 5946 ns
1000 in 11.4 ms: 11398 ns
1000 in 6.2 ms: 6238 ns
1000 in 2.4 ms: 2356 ns
1000 in 9.0 ms: 9032 ns
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.286 sec - in com.conversantmedia.util.concurrent.ConcurrentStackPerformanceTest
Running com.conversantmedia.util.concurrent.DisruptorPutTakeStressTest
0 made progress
1 made progress

Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 6.049 sec - in com.conversantmedia.util.concurrent.DisruptorPutTakeStressTest
Running com.conversantmedia.util.concurrent.PushPullBlockingQueueTest
max value test not executed
Tests run: 30, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 12.244 sec - in com.conversantmedia.util.concurrent.PushPullBlockingQueueTest
Running com.conversantmedia.util.concurrent.PushPullConcurrentQueuePerfTest
Tests run: 1, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 0 sec - in com.conversantmedia.util.concurrent.PushPullConcurrentQueuePerfTest
Running com.conversantmedia.util.concurrent.DisruptorQueuePerfTest
Disruptor
offer (us):, min(0.212), max(3806.743)
0.050:  0.223
0.500:  0.234
0.683:  0.238
0.750:  0.240
0.850:  0.244
0.954:  0.329
0.990: ################################################################################ 28.153

poll (us): , min(0.286), max(4738.645)
0.050:  0.289
0.500:  0.292
0.683:  0.292
0.750:  0.293
0.850:  0.294
0.954: # 0.326
0.990: ################################################################################ 25.190

tot (~us): , min(12.0), max(707.0)
0.050: #### 22.999
0.500: #### 24.816
0.683: #### 25.036
0.750: #### 25.590
0.850: ##### 26.234
0.954: ###### 32.777
0.990: ################################################################################ 414.050

offer (us):, min(0.213), max(4633.297)
0.050:  0.221
0.500:  0.231
0.683:  0.235
0.750:  0.236
0.850:  0.240
0.954:  0.257
0.990: ################################################################################ 24.537

poll (us): , min(0.175), max(4651.476)
0.050:  0.175
0.500:  0.178
0.683:  0.179
0.750:  0.179
0.850:  0.180
0.954:  0.200
0.990: ################################################################################ 29.967

tot (~us): , min(17.0), max(462.0)
0.050: ###################### 17.002
0.500: ########################## 20.007
0.683: ########################### 21.004
0.750: ############################ 21.074
0.850: ############################# 22.015
0.954: ############################### 23.785
0.990: ################################################################################ 60.065

offer (us):, min(0.093), max(3592.124)
0.050:  0.094
0.500:  0.095
0.683:  0.096
0.750:  0.096
0.850:  0.096
0.954:  0.099
0.990: ################################################################################ 18.628

poll (us): , min(0.175), max(6580.545)
0.050: # 0.176
0.500: # 0.179
0.683: # 0.180
0.750: # 0.180
0.850: # 0.181
0.954: # 0.193
0.990: ################################################################################ 13.162

tot (~us): , min(11.0), max(299.0)
0.050: #### 12.000
0.500: ##### 15.003
0.683: ##### 16.000
0.750: ##### 16.000
0.850: ###### 16.576
0.954: ###### 17.958
0.990: ################################################################################ 214.042

16384 in 6.9 ms: 423 ns
16384 in 7.1 ms: 430 ns
16384 in 3.9 ms: 240 ns
16384 in 9.8 ms: 599 ns
16384 in 2.9 ms: 179 ns
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.276 sec - in com.conversantmedia.util.concurrent.DisruptorQueuePerfTest
Running com.conversantmedia.util.concurrent.MultithreadConcurrentQueuePerfTest
Tests run: 1, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 0.001 sec - in com.conversantmedia.util.concurrent.MultithreadConcurrentQueuePerfTest
Running com.conversantmedia.util.concurrent.AtomicSequenceTest
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.034 sec - in com.conversantmedia.util.concurrent.AtomicSequenceTest
Running com.conversantmedia.util.concurrent.ConcurrentStackTest
Tests run: 11, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.104 sec - in com.conversantmedia.util.concurrent.ConcurrentStackTest
Running com.conversantmedia.util.concurrent.AbstractConditionTest
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.026 sec - in com.conversantmedia.util.concurrent.AbstractConditionTest
Running com.conversantmedia.util.concurrent.DisruptorBlockingQueueTest
max value test not executed
Tests run: 30, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.075 sec - in com.conversantmedia.util.concurrent.DisruptorBlockingQueueTest
Running com.conversantmedia.util.concurrent.DisruptorFairSchedulingTest
1024 -1 864339 -1 
5119 4294 1665 2 
Tests run: 2, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 10.199 sec <<< FAILURE! - in com.conversantmedia.util.concurrent.DisruptorFairSchedulingTest
testOfferPollProgress(com.conversantmedia.util.concurrent.DisruptorFairSchedulingTest)  Time elapsed: 10.125 sec  <<< FAILURE!
java.lang.AssertionError: null
	at org.junit.Assert.fail(Assert.java:86)
	at org.junit.Assert.assertTrue(Assert.java:41)
	at org.junit.Assert.assertTrue(Assert.java:52)
	at com.conversantmedia.util.concurrent.DisruptorFairSchedulingTest.testOfferPollProgress(DisruptorFairSchedulingTest.java:120)

Running com.conversantmedia.util.concurrent.DisruptorOfferPollStressTest
0 made progress
1 did not progress

Tests run: 1, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 6.026 sec <<< FAILURE! - in com.conversantmedia.util.concurrent.DisruptorOfferPollStressTest
testOfferPollProgress(com.conversantmedia.util.concurrent.DisruptorOfferPollStressTest)  Time elapsed: 6.024 sec  <<< FAILURE!
java.lang.AssertionError: null
	at org.junit.Assert.fail(Assert.java:86)
	at org.junit.Assert.assertTrue(Assert.java:41)
	at org.junit.Assert.assertTrue(Assert.java:52)
	at com.conversantmedia.util.concurrent.DisruptorOfferPollStressTest.testOfferPollProgress(DisruptorOfferPollStressTest.java:80)

Running com.conversantmedia.util.concurrent.MultithreadConcurrentQueueTest
Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 2.152 sec - in com.conversantmedia.util.concurrent.MultithreadConcurrentQueueTest
Running com.conversantmedia.util.concurrent.AbstractWaitingConditionTest
Tests run: 3, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 1.051 sec - in com.conversantmedia.util.concurrent.AbstractWaitingConditionTest
Running com.conversantmedia.util.concurrent.ConcurrentStackFeedTest
Tests run: 1, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.04 sec - in com.conversantmedia.util.concurrent.ConcurrentStackFeedTest
Running com.conversantmedia.util.concurrent.SequenceLockTest
Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 0.021 sec - in com.conversantmedia.util.concurrent.SequenceLockTest

Results :

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null
  DisruptorOfferPollStressTest.testOfferPollProgress:80 null

Tests run: 102, Failures: 2, Errors: 0, Skipped: 3

[INFO] ------------------------------------------------------------------------
[INFO] BUILD FAILURE
[INFO] ------------------------------------------------------------------------
[INFO] Total time: 44.654 s
[INFO] Finished at: 2016-11-12T05:44:21+01:00
[INFO] Final Memory: 8M/46M
[INFO] ------------------------------------------------------------------------
[ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.17:test (default-test) on project disruptor: There are test failures.
[ERROR] 
[ERROR] Please refer to /<<PKGBUILDDIR>>/target/surefire-reports for the individual test results.
[ERROR] -> [Help 1]
[ERROR] 
[ERROR] To see the full stack trace of the errors, re-run Maven with the -e switch.
[ERROR] Re-run Maven using the -X switch to enable full debug logging.
[ERROR] 
[ERROR] For more information about the errors and possible solutions, please read the following articles:
[ERROR] [Help 1] http://cwiki.apache.org/confluence/display/MAVEN/MojoFailureException
dh_auto_test: /usr/lib/jvm/default-java/bin/java -noverify -cp /usr/share/maven/boot/plexus-classworlds-2.x.jar:/usr/lib/jvm/default-java/lib/tools.jar -Dmaven.home=/usr/share/maven -Dmaven.multiModuleProjectDirectory=/<<PKGBUILDDIR>> -Dclassworlds.conf=/etc/maven/m2-debian.conf -Dproperties.file.manual=/<<PKGBUILDDIR>>/debian/maven.properties org.codehaus.plexus.classworlds.launcher.Launcher -s/etc/maven/settings-debian.xml -Ddebian.dir=/<<PKGBUILDDIR>>/debian -Dmaven.repo.local=/<<PKGBUILDDIR>>/debian/maven-repo test returned exit code 1
debian/rules:4: recipe for target 'build-indep' failed
make: *** [build-indep] Error 1
dpkg-buildpackage: error: debian/rules build-indep gave error exit status 2
--------------------------------------------------------------------------------

The relevant part of the build log is included above.

The failing tests are not always the same. Here is a summary of
everything I got after building this package many times:

------------------------------------------------------------
Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorPutTakeStressTest.testPutTakeProgress:84 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null
  DisruptorOfferPollStressTest.testOfferPollProgress:80 null

Failed tests: 
  DisruptorOfferPollStressTest.testOfferPollProgress:80 null

Failed tests: 
  DisruptorFairSchedulingTest.testOfferPollProgress:120 null

Failed tests: 
  DisruptorOfferPollStressTest.testOfferPollProgress:80 null

Failed tests: 
  DisruptorOfferPollStressTest.testOfferPollProgress:80 null

Failed tests: 
  DisruptorPutTakeStressTest.testPutTakeProgress:84 null
  DisruptorOfferPollStressTest.testOfferPollProgress:80 null
------------------------------------------------------------

There are also build failures here:

https://tests.reproducible-builds.org/debian/rbuild/testing/amd64/conversant-disruptor_1.2.8-1.rbuild.log

Thanks.



More information about the pkg-java-maintainers mailing list