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 2015/05/22 18:47:11 UTC
[JENKINS] Lucene-Solr-5.x-Windows (64bit/jdk1.7.0_80) - Build #
4718 - Failure!
Build: http://jenkins.thetaphi.de/job/Lucene-Solr-5.x-Windows/4718/
Java: 64bit/jdk1.7.0_80 -XX:+UseCompressedOops -XX:+UseConcMarkSweepGC
2 tests failed.
FAILED: org.apache.solr.core.RequestHandlersTest.testStatistics
Error Message:
Test abandoned because suite timeout was reached.
Stack Trace:
java.lang.Exception: Test abandoned because suite timeout was reached.
at __randomizedtesting.SeedInfo.seed([78307338B0DFCF72]:0)
FAILED: junit.framework.TestSuite.org.apache.solr.core.RequestHandlersTest
Error Message:
Suite timeout exceeded (>= 7200000 msec).
Stack Trace:
java.lang.Exception: Suite timeout exceeded (>= 7200000 msec).
at __randomizedtesting.SeedInfo.seed([78307338B0DFCF72]:0)
Build Log:
[...truncated 11110 lines...]
[junit4] Suite: org.apache.solr.core.RequestHandlersTest
[junit4] 2> Creating dataDir: C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\build\solr-core\test\J0\temp\solr.core.RequestHandlersTest 78307338B0DFCF72-001\init-core-data-001
[junit4] 2> 897451 T6840 oas.SolrTestCaseJ4.buildSSLConfig Randomized ssl (true) and clientAuth (false)
[junit4] 2> 897456 T6840 oas.SolrTestCaseJ4.initCore ####initCore
[junit4] 2> 897456 T6840 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: 'C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\collection1\'
[junit4] 2> 897457 T6840 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-5.x-Windows/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
[junit4] 2> 897457 T6840 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-5.x-Windows/solr/core/src/test-files/solr/collection1/lib/README' to classloader
[junit4] 2> 897526 T6840 oasc.SolrConfig.refreshRequestParams current version of requestparams : -1
[junit4] 2> 897573 T6840 oasc.SolrConfig.<init> Using Lucene MatchVersion: 5.3.0
[junit4] 2> 897630 T6840 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 897631 T6840 oass.IndexSchema.readSchema Reading Solr Schema from C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
[junit4] 2> 897638 T6840 oass.IndexSchema.readSchema [null] Schema name=test
[junit4] 2> 898088 T6840 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 898101 T6840 oass.IndexSchema.readSchema default search field in schema is text
[junit4] 2> 898118 T6840 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 898124 T6840 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 898127 T6840 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 898130 T6840 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 898130 T6840 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 898131 T6840 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 898132 T6840 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 898132 T6840 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 898132 T6840 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 898133 T6840 oasc.SolrResourceLoader.locateSolrHome JNDI not configured for solr (NoInitialContextEx)
[junit4] 2> 898133 T6840 oasc.SolrResourceLoader.locateSolrHome using system property solr.solr.home: C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr
[junit4] 2> 898133 T6840 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: 'C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\'
[junit4] 2> 898155 T6840 oasc.CoreContainer.<init> New CoreContainer 1188332566
[junit4] 2> 898155 T6840 oasc.CoreContainer.load Loading cores into CoreContainer [instanceDir=C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\]
[junit4] 2> 898155 T6840 oasc.CoreContainer.load loading shared library: C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\lib
[junit4] 2> 898155 T6840 oasc.SolrResourceLoader.addToClassLoader WARN Can't find (or read) directory to add to classloader: lib (resolved as: C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\lib).
[junit4] 2> 898164 T6840 oashc.HttpShardHandlerFactory.init created with socketTimeout : 600000,connTimeout : 60000,maxConnectionsPerHost : 20,maxConnections : 10000,corePoolSize : 0,maximumPoolSize : 2147483647,maxThreadIdleTime : 5,sizeOfQueue : -1,fairnessPolicy : false,useRetries : false,
[junit4] 2> 898173 T6840 oasu.UpdateShardHandler.<init> Creating UpdateShardHandler HTTP client with params: socketTimeout=30000&connTimeout=30000&retry=true
[junit4] 2> 898178 T6840 oasl.LogWatcher.createWatcher SLF4J impl is org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 898178 T6840 oasl.LogWatcher.newRegisteredLogWatcher Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 898178 T6840 oasc.CoreContainer.load Node Name: testNode
[junit4] 2> 898178 T6840 oasc.CoreContainer.initializeAuthenticationPlugin No authentication plugin used.
[junit4] 2> 898179 T6840 oasc.CoreDescriptor.<init> CORE DESCRIPTOR: {collection=collection1, instanceDir=collection1, schema=schema.xml, transient=false, config=solrconfig.xml, absoluteInstDir=C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\collection1\, dataDir=C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\build\solr-core\test\J0\temp\solr.core.RequestHandlersTest 78307338B0DFCF72-001\init-core-data-001, name=collection1, shard=shard1, loadOnStartup=true}
[junit4] 2> 898180 T6841 oasc.SolrResourceLoader.<init> new SolrResourceLoader for directory: 'C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\collection1\'
[junit4] 2> 898181 T6841 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-5.x-Windows/solr/core/src/test-files/solr/collection1/lib/classes/' to classloader
[junit4] 2> 898181 T6841 oasc.SolrResourceLoader.replaceClassLoader Adding 'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-5.x-Windows/solr/core/src/test-files/solr/collection1/lib/README' to classloader
[junit4] 2> 898236 T6841 oasc.SolrConfig.refreshRequestParams current version of requestparams : -1
[junit4] 2> 898270 T6841 oasc.SolrConfig.<init> Using Lucene MatchVersion: 5.3.0
[junit4] 2> 898342 T6841 oasc.SolrConfig.<init> Loaded SolrConfig: solrconfig.xml
[junit4] 2> 898342 T6841 oass.IndexSchema.readSchema Reading Solr Schema from C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
[junit4] 2> 898350 T6841 oass.IndexSchema.readSchema [collection1] Schema name=test
[junit4] 2> 898812 T6841 oass.OpenExchangeRatesOrgProvider.init Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 898824 T6841 oass.IndexSchema.readSchema default search field in schema is text
[junit4] 2> 898826 T6841 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 898840 T6841 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 898844 T6841 oass.FileExchangeRateProvider.reload Reloading exchange rates from file currency.xml
[junit4] 2> 898848 T6841 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 898848 T6841 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 898848 T6841 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 898849 T6841 oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 898849 T6841 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key IMPORTANT NOTE
[junit4] 2> 898849 T6841 oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key, got STRING
[junit4] 2> 898851 T6841 oasc.CoreContainer.create Creating SolrCore 'collection1' using configuration from instancedir C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\collection1\
[junit4] 2> 898851 T6841 x:collection1 oasc.SolrCore.initDirectoryFactory org.apache.solr.core.MockDirectoryFactory
[junit4] 2> 898853 T6841 x:collection1 oasc.SolrCore.<init> [[collection1] ] Opening new SolrCore at [C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\core\src\test-files\solr\collection1\], dataDir=[null]
[junit4] 2> 898853 T6841 x:collection1 oasc.JmxMonitoredMap.<init> JMX monitoring is enabled. Adding Solr mbeans to JMX Server: com.sun.jmx.mbeanserver.JmxMBeanServer@3f3df5e3
[junit4] 2> 898854 T6841 x:collection1 oasc.CachingDirectoryFactory.get return new directory for C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\build\solr-core\test\J0\temp\solr.core.RequestHandlersTest 78307338B0DFCF72-001\init-core-data-001\
[junit4] 2> 898854 T6841 x:collection1 oasc.SolrCore.getNewIndexDir New index directory detected: old=null new=C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\build\solr-core\test\J0\temp\solr.core.RequestHandlersTest 78307338B0DFCF72-001\init-core-data-001\index/
[junit4] 2> 898854 T6841 x:collection1 oasc.SolrCore.initIndex WARN [collection1] Solr index directory 'C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\build\solr-core\test\J0\temp\solr.core.RequestHandlersTest 78307338B0DFCF72-001\init-core-data-001\index' doesn't exist. Creating new index...
[junit4] 2> 898854 T6841 x:collection1 oasc.CachingDirectoryFactory.get return new directory for C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\build\solr-core\test\J0\temp\solr.core.RequestHandlersTest 78307338B0DFCF72-001\init-core-data-001\index
[junit4] 2> 898855 T6841 x:collection1 oasu.RandomMergePolicy.<init> RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=11, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=true, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.8905137814762623]
[junit4] 2> 898856 T6841 x:collection1 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=1
[junit4] 2> commit{dir=MockDirectoryWrapper(RAMDirectory@622e0892 lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@3c34db99),segFN=segments_1,generation=1}
[junit4] 2> 898856 T6841 x:collection1 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 898864 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "dedupe"
[junit4] 2> 898865 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4] 2> 898865 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "dedupe-allfields"
[junit4] 2> 898865 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe-allfields"
[junit4] 2> 898865 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "stored_sig"
[junit4] 2> 898866 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4] 2> 898866 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "uniq-fields"
[junit4] 2> 898866 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4] 2> 898866 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "distrib-dup-test-chain-explicit"
[junit4] 2> 898867 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain "distrib-dup-test-chain-implicit"
[junit4] 2> 898867 T6841 x:collection1 oasup.UpdateRequestProcessorChain.init inserting DistributedUpdateProcessorFactory into updateRequestProcessorChain "distrib-dup-test-chain-implicit"
[junit4] 2> 898867 T6841 x:collection1 oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined as default, creating implicit default
[junit4] 2> 898874 T6841 x:collection1 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4] 2> 898877 T6841 x:collection1 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4] 2> 898879 T6841 x:collection1 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4] 2> 898881 T6841 x:collection1 oashl.XMLLoader.init xsltCacheLifetimeSeconds=60
[junit4] 2> 898886 T6841 x:collection1 oasc.PluginBag.createPlugin requestHandler : 'lazy' created with startup=lazy
[junit4] 2> 898889 T6841 x:collection1 oasc.RequestHandlers.initHandlersFromConfig Registered paths: /admin/file,/terms,/admin/mbeans,/admin/ping,/debug/dump,/search-facet-def,dismax,mock,standard,spellCheckCompRH1,/replication,/admin/properties,/admin/segments,defaults,/update/csv,/admin/plugins,/update,/schema,mltrh,/admin/system,spellCheckCompRH_Direct,/mlt,spellCheckWithWordbreak_Direct,/get,/admin/threads,spellCheckWithWordbreak,lazy,/update/json/docs,tvrh,/update/json,/config,spellCheckCompRH,/search-facet-invariants,/admin/logging,/admin/luke
[junit4] 2> 898890 T6841 x:collection1 oasc.SolrCore.initDeprecatedSupport WARN solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your config to use the ShowFileRequestHandler.
[junit4] 2> 898891 T6841 x:collection1 oasc.SolrCore.initStatsCache Using default statsCache cache: org.apache.solr.search.stats.LocalStatsCache
[junit4] 2> 898892 T6841 x:collection1 oasu.UpdateHandler.<init> Using UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 898892 T6841 x:collection1 oasu.UpdateLog.init Initializing UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100 maxNumLogsToKeep=10 numVersionBuckets=256
[junit4] 2> 898893 T6841 x:collection1 oasu.CommitTracker.<init> Hard AutoCommit: disabled
[junit4] 2> 898893 T6841 x:collection1 oasu.CommitTracker.<init> Soft AutoCommit: disabled
[junit4] 2> 898893 T6841 x:collection1 oasu.RandomMergePolicy.<init> RandomMergePolicy wrapping class org.apache.lucene.index.LogDocMergePolicy: [LogDocMergePolicy: minMergeSize=1000, mergeFactor=10, maxMergeSize=9223372036854775807, maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false, maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0]
[junit4] 2> 898894 T6841 x:collection1 oasc.SolrDeletionPolicy.onInit SolrDeletionPolicy.onInit: commits: num=1
[junit4] 2> commit{dir=MockDirectoryWrapper(RAMDirectory@622e0892 lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@3c34db99),segFN=segments_1,generation=1}
[junit4] 2> 898894 T6841 x:collection1 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 898910 T6841 x:collection1 oass.SolrIndexSearcher.<init> Opening Searcher@6edaea0e[collection1] main
[junit4] 2> 898911 T6841 x:collection1 oasu.UpdateLog.onFirstSearcher On first searcher opened, looking up max value of version field
[junit4] 2> 898911 T6841 x:collection1 oasu.VersionInfo.getMaxVersionFromIndex Refreshing highest value of _version_ for 256 version buckets from index
[junit4] 2> 898911 T6841 x:collection1 oasu.VersionInfo.getMaxVersionFromIndex WARN No terms found for _version_, cannot seed version bucket highest value from index
[junit4] 2> 898911 T6841 x:collection1 oasu.UpdateLog.seedBucketsWithHighestVersion WARN Could not find max version in index or recent updates, using new clock 1501881631160401920
[junit4] 2> 898912 T6841 x:collection1 oasu.UpdateLog.seedBucketsWithHighestVersion Took 1 ms to seed version buckets with highest version 1501881631160401920
[junit4] 2> 898912 T6841 x:collection1 oasr.RestManager.init Initializing RestManager with initArgs: {storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
[junit4] 2> 898912 T6841 x:collection1 oasr.ManagedResourceStorage.load Reading _rest_managed.json using InMemoryStorage
[junit4] 2> 898912 T6841 x:collection1 oasr.RestManager.init Initializing 0 registered ManagedResources
[junit4] 2> 898913 T6841 x:collection1 oashc.SpellCheckComponent.inform Initializing spell checkers
[junit4] 2> 898921 T6841 x:collection1 oass.DirectSolrSpellChecker.init init: {name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4] 2> 898971 T6841 x:collection1 oash.ReplicationHandler.inform Commits will be reserved for 10000
[junit4] 2> 898972 T6841 x:collection1 oasc.CoreContainer.registerCore registering core: collection1
[junit4] 2> 898974 T6840 oas.SolrTestCaseJ4.initCore ####initCore end
[junit4] 2> 898980 T6840 oas.SolrTestCaseJ4.setUp ###Starting testInitCount
[junit4] 2> 898980 T6840 oas.SolrTestCaseJ4.tearDown ###Ending testInitCount
[junit4] 2> 898986 T6840 oas.SolrTestCaseJ4.setUp ###Starting testStatistics
[junit4] 2> ASYNC NEW_CORE C2965 name=collection1 org.apache.solr.core.SolrCore@40e1b427
[junit4] 2> 898990 T6840 C2965 oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={} {add=[47 (1501881631240093696)]} 0 3
[junit4] 2> 898996 T6840 C2965 oasu.DirectUpdateHandler2.commit start commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
[junit4] 2> 898998 T6840 C2965 oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
[junit4] 2> commit{dir=MockDirectoryWrapper(RAMDirectory@622e0892 lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@3c34db99),segFN=segments_1,generation=1}
[junit4] 2> commit{dir=MockDirectoryWrapper(RAMDirectory@622e0892 lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@3c34db99),segFN=segments_2,generation=2}
[junit4] 2> 898999 T6840 C2965 oasc.SolrDeletionPolicy.updateCommits newest commit generation = 2
[junit4] 2> 898999 T6840 C2965 oasc.SolrCore.getSearcher WARN [collection1] PERFORMANCE WARNING: Overlapping onDeckSearchers=2
[junit4] 2> 899000 T6840 C2965 oass.SolrIndexSearcher.<init> Opening Searcher@79421279[collection1] main
[junit4] 2> 899001 T6840 C2965 oasu.UpdateLog.onFirstSearcher On first searcher opened, looking up max value of version field
[junit4] 2> 899003 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: default
[junit4] 2> 899003 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: direct
[junit4] 2> 899003 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: wordbreak
[junit4] 2> 899003 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: multipleFields
[junit4] 2> 899004 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: jarowinkler
[junit4] 2> 899005 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: external
[junit4] 2> 899005 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: freq
[junit4] 2> 899006 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: fqcn
[junit4] 2> 899006 T6842 x:collection1 oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index for spellchecker: perDict
[junit4] 2> 899007 T6842 x:collection1 oasc.SolrCore.registerSearcher [collection1] Registered new searcher Searcher@6edaea0e[collection1] main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 7258270 T6839 ccr.ThreadLeakControl$2.evaluate WARNING Suite execution timed out: org.apache.solr.core.RequestHandlersTest
[junit4] 2> ==== jstack at approximately timeout time ====
[junit4] 2> "Thread-1493" ID=6843 WAITING on java.lang.Object@20c2f324
[junit4] 2> at java.lang.Object.wait(Native Method)
[junit4] 2> - waiting on java.lang.Object@20c2f324
[junit4] 2> at java.lang.Object.wait(Object.java:503)
[junit4] 2> at org.apache.solr.core.CloserThread.run(CoreContainer.java:1035)
[junit4] 2>
[junit4] 2> "searcherExecutor-2363-thread-1" ID=6842 WAITING on java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject@5ee8d149
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> - waiting on java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject@5ee8d149
[junit4] 2> at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2043)
[junit4] 2> at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1068)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1130)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2>
[junit4] 2> "TEST-RequestHandlersTest.testStatistics-seed#[78307338B0DFCF72]" ID=6840 WAITING on java.util.concurrent.locks.ReentrantReadWriteLock$FairSync@2a267f0c
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> - waiting on java.util.concurrent.locks.ReentrantReadWriteLock$FairSync@2a267f0c
[junit4] 2> at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.parkAndCheckInterrupt(AbstractQueuedSynchronizer.java:834)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquireQueued(AbstractQueuedSynchronizer.java:867)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquire(AbstractQueuedSynchronizer.java:1197)
[junit4] 2> at java.util.concurrent.locks.ReentrantReadWriteLock$WriteLock.lock(ReentrantReadWriteLock.java:945)
[junit4] 2> at org.apache.solr.update.VersionInfo.blockUpdates(VersionInfo.java:118)
[junit4] 2> at org.apache.solr.update.UpdateLog.onFirstSearcher(UpdateLog.java:1604)
[junit4] 2> at org.apache.solr.core.SolrCore.getSearcher(SolrCore.java:1810)
[junit4] 2> at org.apache.solr.core.SolrCore.getSearcher(SolrCore.java:1505)
[junit4] 2> at org.apache.solr.update.DirectUpdateHandler2.commit(DirectUpdateHandler2.java:617)
[junit4] 2> - locked java.lang.Object@704404d
[junit4] 2> at org.apache.solr.update.processor.RunUpdateProcessor.processCommit(RunUpdateProcessorFactory.java:95)
[junit4] 2> at org.apache.solr.update.processor.UpdateRequestProcessor.processCommit(UpdateRequestProcessor.java:64)
[junit4] 2> at org.apache.solr.update.processor.DistributedUpdateProcessor.doLocalCommit(DistributedUpdateProcessor.java:1635)
[junit4] 2> at org.apache.solr.update.processor.DistributedUpdateProcessor.processCommit(DistributedUpdateProcessor.java:1612)
[junit4] 2> at org.apache.solr.update.processor.LogUpdateProcessor.processCommit(LogUpdateProcessorFactory.java:161)
[junit4] 2> at org.apache.solr.handler.loader.XMLLoader.processUpdate(XMLLoader.java:270)
[junit4] 2> at org.apache.solr.handler.loader.XMLLoader.load(XMLLoader.java:177)
[junit4] 2> at org.apache.solr.handler.UpdateRequestHandler$1.load(UpdateRequestHandler.java:98)
[junit4] 2> at org.apache.solr.handler.ContentStreamHandlerBase.handleRequestBody(ContentStreamHandlerBase.java:74)
[junit4] 2> at org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:143)
[junit4] 2> at org.apache.solr.core.SolrCore.execute(SolrCore.java:2051)
[junit4] 2> at org.apache.solr.servlet.DirectSolrConnection.request(DirectSolrConnection.java:131)
[junit4] 2> at org.apache.solr.util.TestHarness.update(TestHarness.java:267)
[junit4] 2> at org.apache.solr.util.BaseTestHarness.checkUpdateStatus(BaseTestHarness.java:282)
[junit4] 2> at org.apache.solr.util.BaseTestHarness.validateUpdate(BaseTestHarness.java:252)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.checkUpdateU(SolrTestCaseJ4.java:748)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.assertU(SolrTestCaseJ4.java:727)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.assertU(SolrTestCaseJ4.java:721)
[junit4] 2> at org.apache.solr.core.RequestHandlersTest.testStatistics(RequestHandlersTest.java:107)
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
[junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:606)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1627)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:836)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:872)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:886)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[junit4] 2> at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
[junit4] 2> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:365)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:798)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:458)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:845)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:747)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:781)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:792)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:54)
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:365)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2> Locked synchronizers:
[junit4] 2> - java.util.concurrent.locks.ReentrantLock$FairSync@281982d4
[junit4] 2> - java.util.concurrent.locks.ReentrantLock$NonfairSync@22dc40dd
[junit4] 2>
[junit4] 2> "SUITE-RequestHandlersTest-seed#[78307338B0DFCF72]" ID=6839 RUNNABLE
[junit4] 2> at sun.management.ThreadImpl.dumpThreads0(Native Method)
[junit4] 2> at sun.management.ThreadImpl.dumpAllThreads(ThreadImpl.java:446)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.formatThreadStacksFull(ThreadLeakControl.java:671)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.access$900(ThreadLeakControl.java:62)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$2.evaluate(ThreadLeakControl.java:412)
[junit4] 2> - locked java.lang.Object@455f0272
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSuite(RandomizedRunner.java:651)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.access$200(RandomizedRunner.java:138)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$1.run(RandomizedRunner.java:568)
[junit4] 2>
[junit4] 2> "JUnit4-serializer-daemon" ID=11 TIMED_WAITING
[junit4] 2> at java.lang.Thread.sleep(Native Method)
[junit4] 2> at com.carrotsearch.ant.tasks.junit4.events.Serializer$1.run(Serializer.java:47)
[junit4] 2>
[junit4] 2> "Attach Listener" ID=6 RUNNABLE
[junit4] 2>
[junit4] 2> "Signal Dispatcher" ID=5 RUNNABLE
[junit4] 2>
[junit4] 2> "Finalizer" ID=3 WAITING on java.lang.ref.ReferenceQueue$Lock@6099adf2
[junit4] 2> at java.lang.Object.wait(Native Method)
[junit4] 2> - waiting on java.lang.ref.ReferenceQueue$Lock@6099adf2
[junit4] 2> at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:135)
[junit4] 2> at java.lang.ref.ReferenceQueue.remove(ReferenceQueue.java:151)
[junit4] 2> at java.lang.ref.Finalizer$FinalizerThread.run(Finalizer.java:209)
[junit4] 2>
[junit4] 2> "Reference Handler" ID=2 WAITING on java.lang.ref.Reference$Lock@96b1c6a
[junit4] 2> at java.lang.Object.wait(Native Method)
[junit4] 2> - waiting on java.lang.ref.Reference$Lock@96b1c6a
[junit4] 2> at java.lang.Object.wait(Object.java:503)
[junit4] 2> at java.lang.ref.Reference$ReferenceHandler.run(Reference.java:133)
[junit4] 2>
[junit4] 2> "main" ID=1 WAITING on com.carrotsearch.randomizedtesting.RandomizedRunner$1@12c25bea
[junit4] 2> at java.lang.Object.wait(Native Method)
[junit4] 2> - waiting on com.carrotsearch.randomizedtesting.RandomizedRunner$1@12c25bea
[junit4] 2> at java.lang.Thread.join(Thread.java:1281)
[junit4] 2> at java.lang.Thread.join(Thread.java:1355)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSuite(RandomizedRunner.java:578)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.run(RandomizedRunner.java:444)
[junit4] 2> at com.carrotsearch.ant.tasks.junit4.slave.SlaveMain.execute(SlaveMain.java:199)
[junit4] 2> at com.carrotsearch.ant.tasks.junit4.slave.SlaveMain.main(SlaveMain.java:310)
[junit4] 2> at com.carrotsearch.ant.tasks.junit4.slave.SlaveMainSafe.main(SlaveMainSafe.java:12)
[junit4] 2>
[junit4] 2> ^^==============================================
[junit4] 2>
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=RequestHandlersTest -Dtests.method=testStatistics -Dtests.seed=78307338B0DFCF72 -Dtests.slow=true -Dtests.locale=ro_RO -Dtests.timezone=Antarctica/Palmer -Dtests.asserts=true -Dtests.file.encoding=US-ASCII
[junit4] ERROR 7257s J0 | RequestHandlersTest.testStatistics <<<
[junit4] > Throwable #1: java.lang.Exception: Test abandoned because suite timeout was reached.
[junit4] > at __randomizedtesting.SeedInfo.seed([78307338B0DFCF72]:0)
[junit4] 2> 7258276 T6839 ccr.ThreadLeakControl.checkThreadLeaks WARNING Will linger awaiting termination of 3 leaked thread(s).
[junit4] 2> 7278528 T6839 ccr.ThreadLeakControl.checkThreadLeaks SEVERE 3 threads leaked from SUITE scope at org.apache.solr.core.RequestHandlersTest:
[junit4] 2> 1) Thread[id=6842, name=searcherExecutor-2363-thread-1, state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2043)
[junit4] 2> at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1068)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1130)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2> 2) Thread[id=6843, name=Thread-1493, state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> at java.lang.Object.wait(Native Method)
[junit4] 2> at java.lang.Object.wait(Object.java:503)
[junit4] 2> at org.apache.solr.core.CloserThread.run(CoreContainer.java:1035)
[junit4] 2> 3) Thread[id=6840, name=TEST-RequestHandlersTest.testStatistics-seed#[78307338B0DFCF72], state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.parkAndCheckInterrupt(AbstractQueuedSynchronizer.java:834)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquireQueued(AbstractQueuedSynchronizer.java:867)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquire(AbstractQueuedSynchronizer.java:1197)
[junit4] 2> at java.util.concurrent.locks.ReentrantReadWriteLock$WriteLock.lock(ReentrantReadWriteLock.java:945)
[junit4] 2> at org.apache.solr.update.VersionInfo.blockUpdates(VersionInfo.java:118)
[junit4] 2> at org.apache.solr.update.UpdateLog.onFirstSearcher(UpdateLog.java:1604)
[junit4] 2> at org.apache.solr.core.SolrCore.getSearcher(SolrCore.java:1810)
[junit4] 2> at org.apache.solr.core.SolrCore.getSearcher(SolrCore.java:1505)
[junit4] 2> at org.apache.solr.update.DirectUpdateHandler2.commit(DirectUpdateHandler2.java:617)
[junit4] 2> at org.apache.solr.update.processor.RunUpdateProcessor.processCommit(RunUpdateProcessorFactory.java:95)
[junit4] 2> at org.apache.solr.update.processor.UpdateRequestProcessor.processCommit(UpdateRequestProcessor.java:64)
[junit4] 2> at org.apache.solr.update.processor.DistributedUpdateProcessor.doLocalCommit(DistributedUpdateProcessor.java:1635)
[junit4] 2> at org.apache.solr.update.processor.DistributedUpdateProcessor.processCommit(DistributedUpdateProcessor.java:1612)
[junit4] 2> at org.apache.solr.update.processor.LogUpdateProcessor.processCommit(LogUpdateProcessorFactory.java:161)
[junit4] 2> at org.apache.solr.handler.loader.XMLLoader.processUpdate(XMLLoader.java:270)
[junit4] 2> at org.apache.solr.handler.loader.XMLLoader.load(XMLLoader.java:177)
[junit4] 2> at org.apache.solr.handler.UpdateRequestHandler$1.load(UpdateRequestHandler.java:98)
[junit4] 2> at org.apache.solr.handler.ContentStreamHandlerBase.handleRequestBody(ContentStreamHandlerBase.java:74)
[junit4] 2> at org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:143)
[junit4] 2> at org.apache.solr.core.SolrCore.execute(SolrCore.java:2051)
[junit4] 2> at org.apache.solr.servlet.DirectSolrConnection.request(DirectSolrConnection.java:131)
[junit4] 2> at org.apache.solr.util.TestHarness.update(TestHarness.java:267)
[junit4] 2> at org.apache.solr.util.BaseTestHarness.checkUpdateStatus(BaseTestHarness.java:282)
[junit4] 2> at org.apache.solr.util.BaseTestHarness.validateUpdate(BaseTestHarness.java:252)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.checkUpdateU(SolrTestCaseJ4.java:748)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.assertU(SolrTestCaseJ4.java:727)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.assertU(SolrTestCaseJ4.java:721)
[junit4] 2> at org.apache.solr.core.RequestHandlersTest.testStatistics(RequestHandlersTest.java:107)
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
[junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:606)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1627)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:836)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:872)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:886)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[junit4] 2> at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
[junit4] 2> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:365)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:798)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:458)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:845)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:747)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:781)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:792)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:54)
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:365)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2> 7278529 T6839 ccr.ThreadLeakControl.tryToInterruptAll Starting to interrupt leaked threads:
[junit4] 2> 1) Thread[id=6842, name=searcherExecutor-2363-thread-1, state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> 2) Thread[id=6843, name=Thread-1493, state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> 3) Thread[id=6840, name=TEST-RequestHandlersTest.testStatistics-seed#[78307338B0DFCF72], state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> 7281660 T6839 ccr.ThreadLeakControl.tryToInterruptAll SEVERE There are still zombie threads that couldn't be terminated:
[junit4] 2> 1) Thread[id=6842, name=searcherExecutor-2363-thread-1, state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer$ConditionObject.await(AbstractQueuedSynchronizer.java:2043)
[junit4] 2> at java.util.concurrent.LinkedBlockingQueue.take(LinkedBlockingQueue.java:442)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor.getTask(ThreadPoolExecutor.java:1068)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor.runWorker(ThreadPoolExecutor.java:1130)
[junit4] 2> at java.util.concurrent.ThreadPoolExecutor$Worker.run(ThreadPoolExecutor.java:615)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2> 2) Thread[id=6843, name=Thread-1493, state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> at java.lang.Object.wait(Native Method)
[junit4] 2> at java.lang.Object.wait(Object.java:503)
[junit4] 2> at org.apache.solr.core.CloserThread.run(CoreContainer.java:1035)
[junit4] 2> 3) Thread[id=6840, name=TEST-RequestHandlersTest.testStatistics-seed#[78307338B0DFCF72], state=WAITING, group=TGRP-RequestHandlersTest]
[junit4] 2> at sun.misc.Unsafe.park(Native Method)
[junit4] 2> at java.util.concurrent.locks.LockSupport.park(LockSupport.java:186)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.parkAndCheckInterrupt(AbstractQueuedSynchronizer.java:834)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquireQueued(AbstractQueuedSynchronizer.java:867)
[junit4] 2> at java.util.concurrent.locks.AbstractQueuedSynchronizer.acquire(AbstractQueuedSynchronizer.java:1197)
[junit4] 2> at java.util.concurrent.locks.ReentrantReadWriteLock$WriteLock.lock(ReentrantReadWriteLock.java:945)
[junit4] 2> at org.apache.solr.update.VersionInfo.blockUpdates(VersionInfo.java:118)
[junit4] 2> at org.apache.solr.update.UpdateLog.onFirstSearcher(UpdateLog.java:1604)
[junit4] 2> at org.apache.solr.core.SolrCore.getSearcher(SolrCore.java:1810)
[junit4] 2> at org.apache.solr.core.SolrCore.getSearcher(SolrCore.java:1505)
[junit4] 2> at org.apache.solr.update.DirectUpdateHandler2.commit(DirectUpdateHandler2.java:617)
[junit4] 2> at org.apache.solr.update.processor.RunUpdateProcessor.processCommit(RunUpdateProcessorFactory.java:95)
[junit4] 2> at org.apache.solr.update.processor.UpdateRequestProcessor.processCommit(UpdateRequestProcessor.java:64)
[junit4] 2> at org.apache.solr.update.processor.DistributedUpdateProcessor.doLocalCommit(DistributedUpdateProcessor.java:1635)
[junit4] 2> at org.apache.solr.update.processor.DistributedUpdateProcessor.processCommit(DistributedUpdateProcessor.java:1612)
[junit4] 2> at org.apache.solr.update.processor.LogUpdateProcessor.processCommit(LogUpdateProcessorFactory.java:161)
[junit4] 2> at org.apache.solr.handler.loader.XMLLoader.processUpdate(XMLLoader.java:270)
[junit4] 2> at org.apache.solr.handler.loader.XMLLoader.load(XMLLoader.java:177)
[junit4] 2> at org.apache.solr.handler.UpdateRequestHandler$1.load(UpdateRequestHandler.java:98)
[junit4] 2> at org.apache.solr.handler.ContentStreamHandlerBase.handleRequestBody(ContentStreamHandlerBase.java:74)
[junit4] 2> at org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:143)
[junit4] 2> at org.apache.solr.core.SolrCore.execute(SolrCore.java:2051)
[junit4] 2> at org.apache.solr.servlet.DirectSolrConnection.request(DirectSolrConnection.java:131)
[junit4] 2> at org.apache.solr.util.TestHarness.update(TestHarness.java:267)
[junit4] 2> at org.apache.solr.util.BaseTestHarness.checkUpdateStatus(BaseTestHarness.java:282)
[junit4] 2> at org.apache.solr.util.BaseTestHarness.validateUpdate(BaseTestHarness.java:252)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.checkUpdateU(SolrTestCaseJ4.java:748)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.assertU(SolrTestCaseJ4.java:727)
[junit4] 2> at org.apache.solr.SolrTestCaseJ4.assertU(SolrTestCaseJ4.java:721)
[junit4] 2> at org.apache.solr.core.RequestHandlersTest.testStatistics(RequestHandlersTest.java:107)
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] 2> at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57)
[junit4] 2> at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] 2> at java.lang.reflect.Method.invoke(Method.java:606)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1627)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:836)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:872)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:886)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[junit4] 2> at org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
[junit4] 2> at org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:365)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:798)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:458)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:845)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:747)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:781)
[junit4] 2> at com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:792)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
[junit4] 2> at org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:39)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:54)
[junit4] 2> at org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
[junit4] 2> at org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:55)
[junit4] 2> at com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
[junit4] 2> at com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:365)
[junit4] 2> at java.lang.Thread.run(Thread.java:745)
[junit4] 2> NOTE: test params are: codec=Lucene50, sim=DefaultSimilarity, locale=ro_RO, timezone=Antarctica/Palmer
[junit4] 2> NOTE: Windows 7 6.1 amd64/Oracle Corporation 1.7.0_80 (64-bit)/cpus=3,threads=4,free=40031080,total=243257344
[junit4] 2> NOTE: All tests run in this JVM: [SolrCoreTest, TestSolrConfigHandlerCloud, TestCollapseQParserPlugin, TestBinaryField, TestDefaultSearchFieldResource, TestFastLRUCache, TestPartialUpdateDeduplication, BasicDistributedZkTest, TestSolrQueryParserDefaultOperatorResource, DistributedFacetPivotSmallTest, TestMiniSolrCloudClusterSSL, TestExpandComponent, TestNonDefinedSimilarityFactory, SuggesterTest, FieldAnalysisRequestHandlerTest, TestFunctionQuery, ShardSplitTest, TestSortingResponseWriter, SliceStateTest, DefaultValueUpdateProcessorTest, BlockDirectoryTest, ResponseLogComponentTest, RuleEngineTest, TestSurroundQueryParser, TestSolrQueryParserResource, TestInfoStreamLogging, PrimUtilsTest, CoreAdminHandlerTest, LeaderElectionTest, TestObjectReleaseTracker, HdfsChaosMonkeySafeLeaderTest, ZkControllerTest, SolrPluginUtilsTest, UUIDFieldTest, SolrIndexSplitterTest, CollectionReloadTest, SoftAutoCommitTest, TestHdfsUpdateLog, OverseerTest, TestRebalanceLeaders, SolrInfoMBeanTest, TestClusterStateMutator, TestSchemaResource, TestReplicationHandler, TestQueryUtils, TestRandomDVFaceting, CoreAdminCreateDiscoverTest, CursorMarkTest, TestFieldTypeCollectionResource, DocumentAnalysisRequestHandlerTest, TestStressRecovery, DirectSolrConnectionTest, CircularListTest, ScriptEngineTest, TestSort, OverseerStatusTest, DistribDocExpirationUpdateProcessorTest, RequestLoggingTest, RequestHandlersTest]
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=RequestHandlersTest -Dtests.seed=78307338B0DFCF72 -Dtests.slow=true -Dtests.locale=ro_RO -Dtests.timezone=Antarctica/Palmer -Dtests.asserts=true -Dtests.file.encoding=US-ASCII
[junit4] ERROR 0.00s J0 | RequestHandlersTest (suite) <<<
[junit4] > Throwable #1: java.lang.Exception: Suite timeout exceeded (>= 7200000 msec).
[junit4] > at __randomizedtesting.SeedInfo.seed([78307338B0DFCF72]:0)
[junit4] Completed [435/496] on J0 in 7281.71s, 2 tests, 2 errors <<< FAILURES!
[...truncated 200 lines...]
BUILD FAILED
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\build.xml:536: The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\build.xml:484: The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\build.xml:61: The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\extra-targets.xml:39: The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\build.xml:229: The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\solr\common-build.xml:511: The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\lucene\common-build.xml:1433: The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-5.x-Windows\lucene\common-build.xml:991: There were test failures: 496 suites, 1968 tests, 1 suite-level error, 1 error, 236 ignored (34 assumptions)
Total time: 157 minutes 28 seconds
Build step 'Invoke Ant' marked build as failure
Archiving artifacts
Recording test results
Email was triggered for: Failure - Any
Sending email for trigger: Failure - Any