You are viewing a plain text version of this content. The canonical link for it is here.
Posted to dev@lucene.apache.org by Policeman Jenkins Server <je...@thetaphi.de> on 2014/03/14 12:15:54 UTC

[JENKINS] Lucene-Solr-4.x-Linux (32bit/jdk1.7.0_60-ea-b07) - Build # 9682 - Failure!

Build: http://jenkins.thetaphi.de/job/Lucene-Solr-4.x-Linux/9682/
Java: 32bit/jdk1.7.0_60-ea-b07 -client -XX:+UseConcMarkSweepGC

1 tests failed.
REGRESSION:  org.apache.solr.core.TestNonNRTOpen.testReaderIsNotNRT

Error Message:
SOLR-5815? : wrong maxDoc: core=org.apache.solr.core.SolrCore@11b7b80 searcher=Searcher@149f808[collection1] main{StandardDirectoryReader(segments_8:16 _4(4.8):c1 _5(4.8):c1)} expected:<3> but was:<2>

Stack Trace:
java.lang.AssertionError: SOLR-5815? : wrong maxDoc: core=org.apache.solr.core.SolrCore@11b7b80 searcher=Searcher@149f808[collection1] main{StandardDirectoryReader(segments_8:16 _4(4.8):c1 _5(4.8):c1)} expected:<3> but was:<2>
	at __randomizedtesting.SeedInfo.seed([E943992AA2A1ABAD:5CC5F8AD1D601959]:0)
	at org.junit.Assert.fail(Assert.java:93)
	at org.junit.Assert.failNotEquals(Assert.java:647)
	at org.junit.Assert.assertEquals(Assert.java:128)
	at org.junit.Assert.assertEquals(Assert.java:472)
	at org.apache.solr.core.TestNonNRTOpen.assertNotNRT(TestNonNRTOpen.java:142)
	at org.apache.solr.core.TestNonNRTOpen.testReaderIsNotNRT(TestNonNRTOpen.java:100)
	at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
	at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
	at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
	at java.lang.reflect.Method.invoke(Method.java:606)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1617)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:826)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:862)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:876)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
	at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
	at org.apache.lucene.util.TestRuleFieldCacheSanity$1.evaluate(TestRuleFieldCacheSanity.java:51)
	at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
	at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:359)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:783)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:443)
	at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:835)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:737)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:771)
	at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:782)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:53)
	at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
	at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
	at com.carrotsearch.randomizedtesting.rules.SystemPropertiesInvariantRule$1.evaluate(SystemPropertiesInvariantRule.java:55)
	at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
	at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:43)
	at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
	at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:70)
	at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
	at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
	at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:359)
	at java.lang.Thread.run(Thread.java:744)




Build Log:
[...truncated 10351 lines...]
   [junit4] Suite: org.apache.solr.core.TestNonNRTOpen
   [junit4]   2> 99411 T986 oas.SolrTestCaseJ4.buildSSLConfig Randomized ssl (true) and clientAuth (true)
   [junit4]   2> 99411 T986 oas.SolrTestCaseJ4.initCore ####initCore
   [junit4]   2> Creating dataDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495
   [junit4]   2> 99412 T986 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/'
   [junit4]   2> 99412 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/.svn/' to classloader
   [junit4]   2> 99412 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
   [junit4]   2> 99413 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/README' to classloader
   [junit4]   2> 99458 T986 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_48
   [junit4]   2> 99508 T986 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
   [junit4]   2> 99509 T986 oass.IndexSchema.readSchema Reading Solr Schema from schema-minimal.xml
   [junit4]   2> 99512 T986 oass.IndexSchema.readSchema [null] Schema name=minimal
   [junit4]   2> 99518 T986 oass.IndexSchema.readSchema WARN no uniqueKey specified in schema.
   [junit4]   2> 99519 T986 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 99519 T986 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr
   [junit4]   2> 99519 T986 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/'
   [junit4]   2> 99575 T986 oasc.CoreContainer.<init> New CoreContainer 8164838
   [junit4]   2> 99576 T986 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/]
   [junit4]   2> 99577 T986 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 0
   [junit4]   2> 99577 T986 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: null
   [junit4]   2> 99577 T986 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 0
   [junit4]   2> 99578 T986 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
   [junit4]   2> 99578 T986 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
   [junit4]   2> 99578 T986 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
   [junit4]   2> 99578 T986 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
   [junit4]   2> 99579 T986 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
   [junit4]   2> 99579 T986 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
   [junit4]   2> 99583 T986 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
   [junit4]   2> 99583 T986 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
   [junit4]   2> 99583 T986 oasc.CoreContainer.load Host Name: 
   [junit4]   2> 99586 T987 oasc.CoreContainer.create Creating SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1
   [junit4]   2> 99587 T987 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/'
   [junit4]   2> 99587 T987 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/.svn/' to classloader
   [junit4]   2> 99587 T987 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
   [junit4]   2> 99587 T987 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/README' to classloader
   [junit4]   2> 99632 T987 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_48
   [junit4]   2> 99674 T987 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
   [junit4]   2> 99674 T987 oass.IndexSchema.readSchema Reading Solr Schema from schema-minimal.xml
   [junit4]   2> 99678 T987 oass.IndexSchema.readSchema [collection1] Schema name=minimal
   [junit4]   2> 99683 T987 oass.IndexSchema.readSchema WARN no uniqueKey specified in schema.
   [junit4]   2> 99684 T987 oasc.SolrCore.initDirectoryFactory solr.StandardDirectoryFactory
   [junit4]   2> 99684 T987 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/, dataDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/
   [junit4]   2> 99684 T987 oasc.SolrCore.<init> JMX monitoring not detected for core: collection1
   [junit4]   2> 99684 T987 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495
   [junit4]   2> 99685 T987 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/index/
   [junit4]   2> 99685 T987 oasc.SolrCore.initIndex WARN [collection1] Solr index directory '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/index' doesn't exist. Creating new index...
   [junit4]   2> 99685 T987 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index
   [junit4]   2> 99764 T987 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=1
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_1,generation=1}
   [junit4]   2> 99764 T987 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
   [junit4]   2> 99765 T987 oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined as default, creating implicit default
   [junit4]   2> 99766 T987 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
   [junit4]   2> 99766 T987 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
   [junit4]   2> 99768 T987 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
   [junit4]   2> 99770 T987 oasu.CommitTracker.<init> Hard AutoCommit: disabled
   [junit4]   2> 99770 T987 oasu.CommitTracker.<init> Soft AutoCommit: disabled
   [junit4]   2> 99770 T987 oass.SolrIndexSearcher.<init> Opening Searcher@16ae7da[collection1] main
   [junit4]   2> 99771 T987 oasc.CoreContainer.registerCore registering core: collection1
   [junit4]   2> 99771 T988 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@16ae7da[collection1] main{StandardDirectoryReader(segments_1:1)}
   [junit4]   2> 99772 T986 oas.SolrTestCaseJ4.initCore ####initCore end
   [junit4]   2> ASYNC  NEW_CORE C790 name=collection1 org.apache.solr.core.SolrCore@14c36a8
   [junit4]   2> 99774 T986 C790 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits: num=1
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_1,generation=1}
   [junit4]   2> 99774 T986 C790 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
   [junit4]   2> 99775 T986 C790 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 2
   [junit4]   2> 99777 T986 C790 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 99793 T986 C790 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_1,generation=1}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_2,generation=2}
   [junit4]   2> 99794 T986 C790 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 2
   [junit4]   2> 99798 T986 C790 oass.SolrIndexSearcher.<init> Opening Searcher@10c148a[collection1] main
   [junit4]   2> 99798 T986 C790 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 99798 T988 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@10c148a[collection1] main{StandardDirectoryReader(segments_2:3 _0(4.8):c1)}
   [junit4]   2> 99799 T986 C790 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 22
   [junit4]   2> 99800 T986 oas.SolrTestCaseJ4.deleteCore ###deleteCore
   [junit4]   2> 99801 T986 oasc.CoreContainer.shutdown Shutting down CoreContainer instance=8164838
   [junit4]   2> 99801 T986 oasc.SolrCore.close [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@14c36a8
   [junit4]   2> 99801 T986 oasu.DirectUpdateHandler2.close closing DirectUpdateHandler2{commits=1,autocommits=0,soft autocommits=0,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=0,adds=0,deletesById=0,deletesByQuery=0,errors=0,cumulative_adds=1,cumulative_deletesById=0,cumulative_deletesByQuery=0,cumulative_errors=0}
   [junit4]   2> 99801 T986 oasu.SolrCoreState.decrefSolrCoreState Closing SolrCoreState
   [junit4]   2> 99802 T986 oasu.DefaultSolrCoreState.closeIndexWriter SolrCoreState ref count has reached 0 - closing IndexWriter
   [junit4]   2> 99802 T986 oasu.DefaultSolrCoreState.closeIndexWriter closing IndexWriter with IndexWriterCloser
   [junit4]   2> 99802 T986 oasc.SolrCore.closeSearcher [collection1] Closing main searcher on request.
   [junit4]   2> 99803 T986 oasc.CachingDirectoryFactory.close Closing StandardDirectoryFactory - 2 directories currently being tracked
   [junit4]   2> 99803 T986 oasc.CachingDirectoryFactory.closeCacheValue looking to close /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495 [CachedDir<<refCount=0;path=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495;done=false>>]
   [junit4]   2> 99803 T986 oasc.CachingDirectoryFactory.close Closing directory: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495
   [junit4]   2> 99804 T986 oasc.CachingDirectoryFactory.closeCacheValue looking to close /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index [CachedDir<<refCount=0;path=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index;done=false>>]
   [junit4]   2> 99804 T986 oasc.CachingDirectoryFactory.close Closing directory: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index
   [junit4]   2> NOTE: per solr.test.leavedatadir, dataDir will not be removed: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495
   [junit4]   2> 99804 T986 oas.SolrTestCaseJ4.initCore ####initCore
   [junit4]   2> 99805 T986 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/'
   [junit4]   2> 99805 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/.svn/' to classloader
   [junit4]   2> 99805 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
   [junit4]   2> 99806 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/README' to classloader
   [junit4]   2> 99850 T986 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_48
   [junit4]   2> 99892 T986 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
   [junit4]   2> 99893 T986 oass.IndexSchema.readSchema Reading Solr Schema from schema-minimal.xml
   [junit4]   2> 99897 T986 oass.IndexSchema.readSchema [null] Schema name=minimal
   [junit4]   2> 99903 T986 oass.IndexSchema.readSchema WARN no uniqueKey specified in schema.
   [junit4]   2> 99904 T986 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
   [junit4]   2> 99904 T986 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr
   [junit4]   2> 99904 T986 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/'
   [junit4]   2> 99953 T986 oasc.CoreContainer.<init> New CoreContainer 20623943
   [junit4]   2> 99953 T986 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/]
   [junit4]   2> 99954 T986 oashc.HttpShardHandlerFactory.getParameter Setting socketTimeout to: 0
   [junit4]   2> 99954 T986 oashc.HttpShardHandlerFactory.getParameter Setting urlScheme to: null
   [junit4]   2> 99954 T986 oashc.HttpShardHandlerFactory.getParameter Setting connTimeout to: 0
   [junit4]   2> 99954 T986 oashc.HttpShardHandlerFactory.getParameter Setting maxConnectionsPerHost to: 20
   [junit4]   2> 99955 T986 oashc.HttpShardHandlerFactory.getParameter Setting corePoolSize to: 0
   [junit4]   2> 99955 T986 oashc.HttpShardHandlerFactory.getParameter Setting maximumPoolSize to: 2147483647
   [junit4]   2> 99955 T986 oashc.HttpShardHandlerFactory.getParameter Setting maxThreadIdleTime to: 5
   [junit4]   2> 99955 T986 oashc.HttpShardHandlerFactory.getParameter Setting sizeOfQueue to: -1
   [junit4]   2> 99956 T986 oashc.HttpShardHandlerFactory.getParameter Setting fairnessPolicy to: false
   [junit4]   2> 99959 T986 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
   [junit4]   2> 99960 T986 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
   [junit4]   2> 99960 T986 oasc.CoreContainer.load Host Name: 
   [junit4]   2> 99962 T990 oasc.CoreContainer.create Creating SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1
   [junit4]   2> 99963 T990 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/'
   [junit4]   2> 99963 T990 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/.svn/' to classloader
   [junit4]   2> 99963 T990 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
   [junit4]   2> 99963 T990 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/README' to classloader
   [junit4]   2> 100005 T990 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_48
   [junit4]   2> 100037 T990 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
   [junit4]   2> 100037 T990 oass.IndexSchema.readSchema Reading Solr Schema from schema-minimal.xml
   [junit4]   2> 100041 T990 oass.IndexSchema.readSchema [collection1] Schema name=minimal
   [junit4]   2> 100052 T990 oass.IndexSchema.readSchema WARN no uniqueKey specified in schema.
   [junit4]   2> 100052 T990 oasc.SolrCore.initDirectoryFactory solr.StandardDirectoryFactory
   [junit4]   2> 100053 T990 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/, dataDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/
   [junit4]   2> 100053 T990 oasc.SolrCore.<init> JMX monitoring not detected for core: collection1
   [junit4]   2> 100053 T990 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495
   [junit4]   2> 100053 T990 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/index/
   [junit4]   2> 100054 T990 oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined as default, creating implicit default
   [junit4]   2> 100054 T990 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
   [junit4]   2> 100055 T990 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
   [junit4]   2> 100058 T990 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
   [junit4]   2> 100059 T990 oasu.CommitTracker.<init> Hard AutoCommit: disabled
   [junit4]   2> 100060 T990 oasu.CommitTracker.<init> Soft AutoCommit: disabled
   [junit4]   2> 100060 T990 oasc.CachingDirectoryFactory.get return new directory for /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index
   [junit4]   2> 100062 T990 oass.SolrIndexSearcher.<init> Opening Searcher@cdb622[collection1] main
   [junit4]   2> 100062 T990 oasc.CoreContainer.registerCore registering core: collection1
   [junit4]   2> 100062 T991 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@cdb622[collection1] main{StandardDirectoryReader(segments_2:3 _0(4.8):c1)}
   [junit4]   2> 100063 T986 oas.SolrTestCaseJ4.initCore ####initCore end
   [junit4]   2> 100064 T986 oasc.TestNonNRTOpen.assertNotNRT Checking notNRT & maxDoc=1 of core=org.apache.solr.core.SolrCore@350511
   [junit4]   2> 100066 T986 oas.SolrTestCaseJ4.setUp ###Starting testSharedCores
   [junit4]   2> ASYNC  NEW_CORE C791 name=collection1 org.apache.solr.core.SolrCore@350511
   [junit4]   2> 100066 T986 C791 oasu.DirectUpdateHandler2.deleteAll [collection1] REMOVING ALL DOCUMENTS FROM INDEX
   [junit4]   2> 100068 T986 C791 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits: num=1
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_2,generation=2}
   [junit4]   2> 100068 T986 C791 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 2
   [junit4]   2> 100069 T986 C791 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {deleteByQuery=*:*} 0 3
   [junit4]   2> 100070 T986 C791 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 0
   [junit4]   2> 100071 T986 C791 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 100091 T986 C791 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_2,generation=2}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_3,generation=3}
   [junit4]   2> 100092 T986 C791 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 3
   [junit4]   2> 100094 T986 C791 oass.SolrIndexSearcher.<init> Opening Searcher@548ffd[collection1] main
   [junit4]   2> 100095 T986 C791 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 100095 T991 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@548ffd[collection1] main{StandardDirectoryReader(segments_3:6 _1(4.8):c1)}
   [junit4]   2> 100095 T986 C791 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 24
   [junit4]   2> 100097 T986 C791 oasu.DirectUpdateHandler2.commit start commit{,optimize=true,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 100097 T986 C791 oasu.DirectUpdateHandler2.commit No uncommitted changes. Skipping IW.commit.
   [junit4]   2> 100098 T986 C791 oasc.SolrCore.openNewSearcher SolrIndexSearcher has not changed - not re-opening: org.apache.solr.search.SolrIndexSearcher
   [junit4]   2> 100098 T986 C791 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 100099 T986 C791 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {optimize=} 0 2
   [junit4]   2> 100101 T986 C791 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 1
   [junit4]   2> 100102 T986 C791 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 100141 T986 C791 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_3,generation=3}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_4,generation=4}
   [junit4]   2> 100142 T986 C791 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 4
   [junit4]   2> 100145 T986 C791 oass.SolrIndexSearcher.<init> Opening Searcher@177f14[collection1] main
   [junit4]   2> 100145 T986 C791 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 100145 T991 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@177f14[collection1] main{StandardDirectoryReader(segments_4:8 _1(4.8):c1 _2(4.8):c1)}
   [junit4]   2> 100146 T986 C791 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 44
   [junit4]   2> ASYNC  NEW_CORE C792 name=collection1 org.apache.solr.core.SolrCore@350511
   [junit4]   2> 100154 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 0
   [junit4]   2> 100156 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 1
   [junit4]   2> 100156 T986 C792 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 100181 T986 C792 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_4,generation=4}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_5,generation=5}
   [junit4]   2> 100182 T986 C792 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 5
   [junit4]   2> 100185 T986 C792 oass.SolrIndexSearcher.<init> Opening Searcher@1c5816b[collection1] main
   [junit4]   2> 100185 T986 C792 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 100185 T991 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@1c5816b[collection1] main{StandardDirectoryReader(segments_5:10 _1(4.8):c1 _2(4.8):c1 _3(4.8):c2)}
   [junit4]   2> 100186 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 30
   [junit4]   2> 100188 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {deleteByQuery=foo2:doc} 0 1
   [junit4]   2> 100188 T986 C792 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 100212 T986 C792 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_5,generation=5}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_6,generation=6}
   [junit4]   2> 100212 T986 C792 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 6
   [junit4]   2> 100215 T986 C792 oass.SolrIndexSearcher.<init> Opening Searcher@1c8985f[collection1] main
   [junit4]   2> 100215 T986 C792 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 100215 T991 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@1c8985f[collection1] main{StandardDirectoryReader(segments_6:11 _1(4.8):c1 _2(4.8):c1 _3(4.8):c2/1:delGen=1)}
   [junit4]   2> 100216 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 28
   [junit4]   2> 100217 T986 oas.SolrTestCaseJ4.tearDown ###Ending testSharedCores
   [junit4]   2> 100221 T986 oas.SolrTestCaseJ4.setUp ###Starting testReaderIsNotNRT
   [junit4]   2> 100221 T986 C792 oasu.DirectUpdateHandler2.deleteAll [collection1] REMOVING ALL DOCUMENTS FROM INDEX
   [junit4]   2> 100222 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {deleteByQuery=*:*} 0 1
   [junit4]   2> 100223 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 0
   [junit4]   2> 100224 T986 C792 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 100243 T986 C792 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_6,generation=6}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_7,generation=7}
   [junit4]   2> 100244 T986 C792 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 7
   [junit4]   2> 100246 T986 C792 oass.SolrIndexSearcher.<init> Opening Searcher@1f7798c[collection1] main
   [junit4]   2> 100247 T986 C792 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 100247 T991 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@1f7798c[collection1] main{StandardDirectoryReader(segments_7:14 _4(4.8):c1)}
   [junit4]   2> 100247 T986 C792 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 23
   [junit4]   2> 100249 T986 oasc.TestNonNRTOpen.assertNotNRT Checking notNRT & maxDoc=1 of core=org.apache.solr.core.SolrCore@350511
   [junit4]   2> 100249 T986 oasc.TestNonNRTOpen.testReaderIsNotNRT Reloading core: org.apache.solr.core.SolrCore@350511
   [junit4]   2> 100249 T986 oasc.CoreContainer.reload Reloading SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1
   [junit4]   2> 100250 T986 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/'
   [junit4]   2> 100250 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/.svn/' to classloader
   [junit4]   2> 100250 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
   [junit4]   2> 100251 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/README' to classloader
   [junit4]   2> 100289 T986 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_48
   [junit4]   2> 100322 T986 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
   [junit4]   2> 100323 T986 oass.IndexSchema.readSchema Reading Solr Schema from schema-minimal.xml
   [junit4]   2> 100326 T986 oass.IndexSchema.readSchema [collection1] Schema name=minimal
   [junit4]   2> 100342 T986 oass.IndexSchema.readSchema WARN no uniqueKey specified in schema.
   [junit4]   2> 100343 T986 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/, dataDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/
   [junit4]   2> 100343 T986 oasc.SolrCore.<init> JMX monitoring not detected for core: collection1
   [junit4]   2> 100343 T986 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/index/
   [junit4]   2> 100344 T986 oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined as default, creating implicit default
   [junit4]   2> 100344 T986 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
   [junit4]   2> 100345 T986 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
   [junit4]   2> 100347 T986 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
   [junit4]   2> 100349 T986 oasu.CommitTracker.<init> Hard AutoCommit: disabled
   [junit4]   2> 100349 T986 oasu.CommitTracker.<init> Soft AutoCommit: disabled
   [junit4]   2> 100350 T986 oass.SolrIndexSearcher.<init> Opening Searcher@f9d07b[collection1] main
   [junit4]   2> 100351 T986 oasu.DefaultSolrCoreState.newIndexWriter Creating new IndexWriter...
   [junit4]   2> 100351 T986 oasu.DefaultSolrCoreState.newIndexWriter Waiting until IndexWriter is unused... core=collection1
   [junit4]   2> 100351 T986 oasu.DefaultSolrCoreState.newIndexWriter Closing old IndexWriter... core=collection1
   [junit4]   2> 100351 T993 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@f9d07b[collection1] main{StandardDirectoryReader(segments_7:14 _4(4.8):c1)}
   [junit4]   2> 100353 T986 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits: num=1
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_7,generation=7}
   [junit4]   2> 100353 T986 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 7
   [junit4]   2> 100353 T986 oasu.DefaultSolrCoreState.newIndexWriter New IndexWriter is ready to be used.
   [junit4]   2> 100354 T986 oasc.SolrCore.openNewSearcher SolrIndexSearcher has not changed - not re-opening: org.apache.solr.search.SolrIndexSearcher
   [junit4]   2> 100355 T986 oasc.CoreContainer.registerCore replacing core: collection1
   [junit4]   2> 100355 T986 oasc.SolrCore.close [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@350511
   [junit4]   2> 100355 T986 oasu.DirectUpdateHandler2.close closing DirectUpdateHandler2{commits=5,autocommits=0,soft autocommits=0,optimizes=1,rollbacks=0,expungeDeletes=0,docsPending=0,adds=0,deletesById=0,deletesByQuery=0,errors=0,cumulative_adds=5,cumulative_deletesById=0,cumulative_deletesByQuery=3,cumulative_errors=0}
   [junit4]   2> 100356 T986 oasc.SolrCore.closeSearcher [collection1] Closing main searcher on request.
   [junit4]   2> 100356 T986 oasc.TestNonNRTOpen.assertNotNRT Checking notNRT & maxDoc=1 of core=org.apache.solr.core.SolrCore@17bdc3e
   [junit4]   2> ASYNC  NEW_CORE C793 name=collection1 org.apache.solr.core.SolrCore@17bdc3e
   [junit4]   2> 100357 T986 C793 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 1
   [junit4]   2> 100358 T986 C793 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> 100423 T986 C793 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_7,generation=7}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_8,generation=8}
   [junit4]   2> 100424 T986 C793 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 8
   [junit4]   2> 100426 T986 C793 oass.SolrIndexSearcher.<init> Opening Searcher@1685b36[collection1] main
   [junit4]   2> 100426 T986 C793 oasu.DirectUpdateHandler2.commit end_commit_flush
   [junit4]   2> 100426 T993 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@1685b36[collection1] main{StandardDirectoryReader(segments_8:16 _4(4.8):c1 _5(4.8):c1)}
   [junit4]   2> 100427 T986 C793 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {commit=} 0 69
   [junit4]   2> 100429 T986 oasc.TestNonNRTOpen.assertNotNRT Checking notNRT & maxDoc=2 of core=org.apache.solr.core.SolrCore@17bdc3e
   [junit4]   2> 100430 T986 C793 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[(null)]} 0 0
   [junit4]   2> 100432 T986 oasc.TestNonNRTOpen.testReaderIsNotNRT Reloading core: org.apache.solr.core.SolrCore@17bdc3e
   [junit4]   2> 100433 T986 oasc.CoreContainer.reload Reloading SolrCore 'collection1' using instanceDir: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1
   [junit4]   2> 100433 T986 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: '/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/'
   [junit4]   2> 100434 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/.svn/' to classloader
   [junit4]   2> 100434 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
   [junit4]   2> 100435 T986 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/lib/README' to classloader
   [junit4]   2> 100483 T986 oasc.SolrConfig.<init> Using Lucene MatchVersion: LUCENE_48
   [junit4]   2> 100511 T986 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig-basic.xml
   [junit4]   2> 100511 T986 oass.IndexSchema.readSchema Reading Solr Schema from schema-minimal.xml
   [junit4]   2> 100515 T986 oass.IndexSchema.readSchema [collection1] Schema name=minimal
   [junit4]   2> 100532 T986 oass.IndexSchema.readSchema WARN no uniqueKey specified in schema.
   [junit4]   2> 100533 T986 oasc.SolrCore.<init> [collection1] Opening new SolrCore at /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/core/src/test-files/solr/collection1/, dataDir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/
   [junit4]   2> 100533 T986 oasc.SolrCore.<init> JMX monitoring not detected for core: collection1
   [junit4]   2> 100534 T986 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/./solrtest-TestNonNRTOpen-1394794506495/index/
   [junit4]   2> 100535 T986 oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined as default, creating implicit default
   [junit4]   2> 100535 T986 oasc.RequestHandlers.initHandlersFromConfig created standard: solr.StandardRequestHandler
   [junit4]   2> 100535 T986 oasc.RequestHandlers.initHandlersFromConfig created /update: solr.UpdateRequestHandler
   [junit4]   2> 100537 T986 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
   [junit4]   2> 100539 T986 oasu.CommitTracker.<init> Hard AutoCommit: disabled
   [junit4]   2> 100540 T986 oasu.CommitTracker.<init> Soft AutoCommit: disabled
   [junit4]   2> 100542 T986 oass.SolrIndexSearcher.<init> Opening Searcher@149f808[collection1] main
   [junit4]   2> 100542 T986 oasu.DefaultSolrCoreState.newIndexWriter Creating new IndexWriter...
   [junit4]   2> 100542 T986 oasu.DefaultSolrCoreState.newIndexWriter Waiting until IndexWriter is unused... core=collection1
   [junit4]   2> 100542 T986 oasu.DefaultSolrCoreState.newIndexWriter Closing old IndexWriter... core=collection1
   [junit4]   2> 100542 T994 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@149f808[collection1] main{StandardDirectoryReader(segments_8:16 _4(4.8):c1 _5(4.8):c1)}
   [junit4]   2> 100562 T986 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_8,generation=8}
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_9,generation=9}
   [junit4]   2> 100562 T986 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 9
   [junit4]   2> 100565 T986 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits: num=1
   [junit4]   2> 		commit{dir=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index,segFN=segments_9,generation=9}
   [junit4]   2> 100565 T986 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 9
   [junit4]   2> 100565 T986 oasu.DefaultSolrCoreState.newIndexWriter New IndexWriter is ready to be used.
   [junit4]   2> 100568 T986 oass.SolrIndexSearcher.<init> Opening Searcher@10371aa[collection1] main
   [junit4]   2> 100569 T986 oasc.CoreContainer.registerCore replacing core: collection1
   [junit4]   2> 100569 T986 oasc.SolrCore.close [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@17bdc3e
   [junit4]   2> 100569 T986 oasu.DirectUpdateHandler2.close closing DirectUpdateHandler2{commits=1,autocommits=0,soft autocommits=0,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=1,adds=1,deletesById=0,deletesByQuery=0,errors=0,cumulative_adds=2,cumulative_deletesById=0,cumulative_deletesByQuery=0,cumulative_errors=0}
   [junit4]   2> 100570 T986 oasc.SolrCore.closeSearcher [collection1] Closing main searcher on request.
   [junit4]   2> 100570 T986 oasc.TestNonNRTOpen.assertNotNRT Checking notNRT & maxDoc=3 of core=org.apache.solr.core.SolrCore@11b7b80
   [junit4]   2> 100571 T986 oas.SolrTestCaseJ4.tearDown ###Ending testReaderIsNotNRT
   [junit4]   2> 100573 T994 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@10371aa[collection1] main{StandardDirectoryReader(segments_9:18 _4(4.8):c1 _5(4.8):c1 _6(4.8):c1)}
   [junit4]   2> NOTE: reproduce with: ant test  -Dtestcase=TestNonNRTOpen -Dtests.method=testReaderIsNotNRT -Dtests.seed=E943992AA2A1ABAD -Dtests.multiplier=3 -Dtests.slow=true -Dtests.locale=zh_HK -Dtests.timezone=Europe/Guernsey -Dtests.file.encoding=UTF-8
   [junit4] FAILURE 0.37s J0 | TestNonNRTOpen.testReaderIsNotNRT <<<
   [junit4]    > Throwable #1: java.lang.AssertionError: SOLR-5815? : wrong maxDoc: core=org.apache.solr.core.SolrCore@11b7b80 searcher=Searcher@149f808[collection1] main{StandardDirectoryReader(segments_8:16 _4(4.8):c1 _5(4.8):c1)} expected:<3> but was:<2>
   [junit4]    > 	at __randomizedtesting.SeedInfo.seed([E943992AA2A1ABAD:5CC5F8AD1D601959]:0)
   [junit4]    > 	at org.apache.solr.core.TestNonNRTOpen.assertNotNRT(TestNonNRTOpen.java:142)
   [junit4]    > 	at org.apache.solr.core.TestNonNRTOpen.testReaderIsNotNRT(TestNonNRTOpen.java:100)
   [junit4]    > 	at java.lang.Thread.run(Thread.java:744)
   [junit4]   2> 100584 T986 oas.SolrTestCaseJ4.deleteCore ###deleteCore
   [junit4]   2> 100584 T986 oasc.CoreContainer.shutdown Shutting down CoreContainer instance=20623943
   [junit4]   2> 100585 T986 oasc.SolrCore.close [collection1]  CLOSING SolrCore org.apache.solr.core.SolrCore@11b7b80
   [junit4]   2> 100585 T986 oasu.DirectUpdateHandler2.close closing DirectUpdateHandler2{commits=0,autocommits=0,soft autocommits=0,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=0,adds=0,deletesById=0,deletesByQuery=0,errors=0,cumulative_adds=0,cumulative_deletesById=0,cumulative_deletesByQuery=0,cumulative_errors=0}
   [junit4]   2> 100585 T986 oasu.SolrCoreState.decrefSolrCoreState Closing SolrCoreState
   [junit4]   2> 100585 T986 oasu.DefaultSolrCoreState.closeIndexWriter SolrCoreState ref count has reached 0 - closing IndexWriter
   [junit4]   2> 100585 T986 oasu.DefaultSolrCoreState.closeIndexWriter closing IndexWriter with IndexWriterCloser
   [junit4]   2> 100586 T986 oasc.SolrCore.closeSearcher [collection1] Closing main searcher on request.
   [junit4]   2> 100586 T986 oasc.CachingDirectoryFactory.close Closing StandardDirectoryFactory - 2 directories currently being tracked
   [junit4]   2> 100586 T986 oasc.CachingDirectoryFactory.closeCacheValue looking to close /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495 [CachedDir<<refCount=0;path=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495;done=false>>]
   [junit4]   2> 100587 T986 oasc.CachingDirectoryFactory.close Closing directory: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495
   [junit4]   2> 100587 T986 oasc.CachingDirectoryFactory.closeCacheValue looking to close /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index [CachedDir<<refCount=0;path=/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index;done=false>>]
   [junit4]   2> 100587 T986 oasc.CachingDirectoryFactory.close Closing directory: /mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build/solr-core/test/J0/solrtest-TestNonNRTOpen-1394794506495/index
   [junit4]   2> NOTE: test params are: codec=Lucene42, sim=RandomSimilarityProvider(queryNorm=true,coord=yes): {}, locale=zh_HK, timezone=Europe/Guernsey
   [junit4]   2> NOTE: Linux 3.8.0-36-generic i386/Oracle Corporation 1.7.0_60-ea (32-bit)/cpus=8,threads=1,free=27474320,total=81928192
   [junit4]   2> NOTE: All tests run in this JVM: [SimpleFacetsTest, TestSearchPerf, SliceStateTest, TestMergePolicyConfig, BlockCacheTest, TestSerializedLuceneMatchVersion, TestWriterPerf, ZkControllerTest, CircularListTest, SpatialFilterTest, IndexSchemaTest, TestReversedWildcardFilterFactory, PeerSyncTest, TestValueSourceCache, ResourceLoaderTest, HdfsChaosMonkeySafeLeaderTest, TestExtendedDismaxParser, TestSolrXml, DOMUtilTest, CopyFieldTest, TestElisionMultitermQuery, TestSurroundQueryParser, FileBasedSpellCheckerTest, SuggesterFSTTest, TestLFUCache, TestConfig, TestReplicationHandler, TestPerFieldSimilarity, TestUniqueKeyFieldResource, TestSolrXMLSerializer, TestGroupingSearch, TestSystemIdResolver, TestNonNRTOpen]
   [junit4] Completed on J0 in 1.20s, 2 tests, 1 failure <<< FAILURES!

[...truncated 999 lines...]
BUILD FAILED
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/build.xml:467: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/build.xml:447: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/build.xml:45: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/extra-targets.xml:37: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/build.xml:189: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/solr/common-build.xml:490: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/lucene/common-build.xml:1276: The following error occurred while executing this line:
/mnt/ssd/jenkins/workspace/Lucene-Solr-4.x-Linux/lucene/common-build.xml:908: There were test failures: 369 suites, 1581 tests, 1 failure, 37 ignored (16 assumptions)

Total time: 48 minutes 0 seconds
Build step 'Invoke Ant' marked build as failure
Description set: Java: 32bit/jdk1.7.0_60-ea-b07 -client -XX:+UseConcMarkSweepGC
Archiving artifacts
Recording test results
Email was triggered for: Failure
Sending email for trigger: Failure