Build: http://jenkins.thetaphi.de/job/Lucene-Solr-trunk-Windows/4724/
Java: 32bit/jdk1.8.0_40 -server -XX:+UseConcMarkSweepGC
1 tests failed.
FAILED: org.apache.solr.update.AutoCommitTest.testMaxTime
Error Message:
Exception during query
Stack Trace:
java.lang.RuntimeException: Exception during query
at
__randomizedtesting.SeedInfo.seed([709987D71C07735C:EA6DFA35829DEF60]:0)
at org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:794)
at
org.apache.solr.update.AutoCommitTest.testMaxTime(AutoCommitTest.java:237)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
at java.lang.reflect.Method.invoke(Method.java:497)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1627)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:836)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:872)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:886)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:50)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:49)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
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:365)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:798)
at
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:458)
at
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:845)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$3.evaluate(RandomizedRunner.java:747)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$4.evaluate(RandomizedRunner.java:781)
at
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:792)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
at
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:46)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:42)
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
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
at
org.apache.lucene.util.TestRuleAssertionsRequired$1.evaluate(TestRuleAssertionsRequired.java:54)
at
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:48)
at
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:65)
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:365)
at java.lang.Thread.run(Thread.java:745)
Caused by: java.lang.RuntimeException: REQUEST FAILED:
xpath=//result[@numFound=1]
xml response was: <?xml version="1.0" encoding="UTF-8"?>
<response>
<lst name="responseHeader"><int name="status">0</int><int
name="QTime">0</int></lst><result name="response" numFound="0"
start="0"></result>
</response>
request was:q=id:529&qt=standard&start=0&rows=20&version=2.2
at org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:787)
... 40 more
Build Log:
[...truncated 9550 lines...]
[junit4] Suite: org.apache.solr.update.AutoCommitTest
[junit4] 2> Creating dataDir:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001
[junit4] 2> 455400 T2198 oas.SolrTestCaseJ4.buildSSLConfig Randomized ssl
(false) and clientAuth (false)
[junit4] 2> 455401 T2198 oas.SolrTestCaseJ4.initCore ####initCore
[junit4] 2> 455401 T2198 oasc.SolrResourceLoader.<init> new
SolrResourceLoader for directory:
'C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\'
[junit4] 2> 455402 T2198 oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/classes/'
to classloader
[junit4] 2> 455402 T2198 oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/README'
to classloader
[junit4] 2> 455442 T2198 oasc.SolrConfig.refreshRequestParams current
version of requestparams : -1
[junit4] 2> 455452 T2198 oasc.SolrConfig.<init> Using Lucene MatchVersion:
6.0.0
[junit4] 2> 455478 T2198 oasc.SolrConfig.<init> Loaded SolrConfig:
solrconfig.xml
[junit4] 2> 455479 T2198 oass.IndexSchema.readSchema Reading Solr Schema
from
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
[junit4] 2> 455484 T2198 oass.IndexSchema.readSchema [null] Schema
name=test
[junit4] 2> 455573 T2198 oass.OpenExchangeRatesOrgProvider.init
Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 455579 T2198 oass.IndexSchema.readSchema default search field
in schema is text
[junit4] 2> 455580 T2198 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 455587 T2198 oass.FileExchangeRateProvider.reload Reloading
exchange rates from file currency.xml
[junit4] 2> 455589 T2198 oass.FileExchangeRateProvider.reload Reloading
exchange rates from file currency.xml
[junit4] 2> 455590 T2198 oass.OpenExchangeRatesOrgProvider.reload
Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 455591 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 455591 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 455591 T2198 oass.OpenExchangeRatesOrgProvider.reload
Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 455591 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 455591 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 455591 T2198 oasc.SolrResourceLoader.locateSolrHome JNDI not
configured for solr (NoInitialContextEx)
[junit4] 2> 455591 T2198 oasc.SolrResourceLoader.locateSolrHome using
system property solr.solr.home:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr
[junit4] 2> 455592 T2198 oasc.SolrResourceLoader.<init> new
SolrResourceLoader for directory:
'C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\'
[junit4] 2> 455609 T2198 oasc.CoreContainer.<init> New CoreContainer
17608848
[junit4] 2> 455609 T2198 oasc.CoreContainer.load Loading cores into
CoreContainer
[instanceDir=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\]
[junit4] 2> 455610 T2198 oasc.CoreContainer.load loading shared library:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\lib
[junit4] 2> 455610 T2198 oasc.SolrResourceLoader.addToClassLoader WARN
Can't find (or read) directory to add to classloader: lib (resolved as:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\lib).
[junit4] 2> 455616 T2198 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> 455627 T2198 oasu.UpdateShardHandler.<init> Creating
UpdateShardHandler HTTP client with params:
socketTimeout=30000&connTimeout=30000&retry=true
[junit4] 2> 455629 T2198 oasl.LogWatcher.createWatcher SLF4J impl is
org.slf4j.impl.Log4jLoggerFactory
[junit4] 2> 455629 T2198 oasl.LogWatcher.newRegisteredLogWatcher
Registering Log Listener [Log4j (org.slf4j.impl.Log4jLoggerFactory)]
[junit4] 2> 455629 T2198 oasc.CoreContainer.load Node Name: testNode
[junit4] 2> 455630 T2198 oasc.CoreDescriptor.<init> CORE DESCRIPTOR:
{name=collection1, config=solrconfig.xml, transient=false, schema=schema.xml,
loadOnStartup=true, instanceDir=collection1, collection=collection1,
absoluteInstDir=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\,
dataDir=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001, shard=shard1}
[junit4] 2> 455631 T2199 oasc.SolrResourceLoader.<init> new
SolrResourceLoader for directory:
'C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\'
[junit4] 2> 455631 T2199 oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/classes/'
to classloader
[junit4] 2> 455632 T2199 oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/README'
to classloader
[junit4] 2> 455650 T2199 oasc.SolrConfig.refreshRequestParams current
version of requestparams : -1
[junit4] 2> 455672 T2199 oasc.SolrConfig.<init> Using Lucene MatchVersion:
6.0.0
[junit4] 2> 455696 T2199 oasc.SolrConfig.<init> Loaded SolrConfig:
solrconfig.xml
[junit4] 2> 455697 T2199 oass.IndexSchema.readSchema Reading Solr Schema
from
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
[junit4] 2> 455701 T2199 oass.IndexSchema.readSchema [collection1] Schema
name=test
[junit4] 2> 455912 T2199 oass.OpenExchangeRatesOrgProvider.init
Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 455917 T2199 oass.IndexSchema.readSchema default search field
in schema is text
[junit4] 2> 455918 T2199 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 455923 T2199 oass.FileExchangeRateProvider.reload Reloading
exchange rates from file currency.xml
[junit4] 2> 455925 T2199 oass.FileExchangeRateProvider.reload Reloading
exchange rates from file currency.xml
[junit4] 2> 455929 T2199 oass.OpenExchangeRatesOrgProvider.reload
Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 455929 T2199
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 455930 T2199
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 455930 T2199 oass.OpenExchangeRatesOrgProvider.reload
Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 455930 T2199
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 455930 T2199
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 455930 T2199 oasc.CoreContainer.create Creating SolrCore
'collection1' using configuration from instancedir
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\
[junit4] 2> 455931 T2199 c:collection1 oasc.SolrCore.initDirectoryFactory
org.apache.solr.core.MockDirectoryFactory
[junit4] 2> 455931 T2199 c:collection1 oasc.SolrCore.<init> [[collection1]
] Opening new SolrCore at
[C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\],
dataDir=[null]
[junit4] 2> 455931 T2199 c:collection1 oasc.JmxMonitoredMap.<init> JMX
monitoring is enabled. Adding Solr mbeans to JMX Server:
com.sun.jmx.mbeanserver.JmxMBeanServer@1987ed3
[junit4] 2> 455932 T2199 c:collection1 oasc.CachingDirectoryFactory.get
return new directory for
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\
[junit4] 2> 455932 T2199 c:collection1 oasc.SolrCore.getNewIndexDir New
index directory detected: old=null
new=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index/
[junit4] 2> 455932 T2199 c:collection1 oasc.SolrCore.initIndex WARN
[collection1] Solr index directory
'C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index' doesn't exist. Creating new
index...
[junit4] 2> 455932 T2199 c:collection1 oasc.CachingDirectoryFactory.get
return new directory for
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index
[junit4] 2> 455932 T2199 c:collection1 oasu.RandomMergePolicy.<init>
RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy:
[TieredMergePolicy: maxMergeAtOnce=42, maxMergeAtOnceExplicit=10,
maxMergedSegmentMB=69.91015625, floorSegmentMB=1.736328125,
forceMergeDeletesPctAllowed=21.847986478264836, segmentsPerTier=13.0,
maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=1.0
[junit4] 2> 455933 T2199 c:collection1 oasc.SolrDeletionPolicy.onCommit
SolrDeletionPolicy.onCommit: commits: num=1
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_1,generation=1}
[junit4] 2> 455933 T2199 c:collection1
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 455936 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe"
[junit4] 2> 455936 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4] 2> 455937 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 455937 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 455937 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"stored_sig"
[junit4] 2> 455937 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4] 2> 455937 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"uniq-fields"
[junit4] 2> 455937 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4] 2> 455937 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-explicit"
[junit4] 2> 455938 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 455938 T2199 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 455938 T2199 c:collection1
oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined
as default, creating implicit default
[junit4] 2> 455942 T2199 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 455944 T2199 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 455945 T2199 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 455947 T2199 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 455950 T2199 c:collection1 oasc.PluginBag.createPlugin
requestHandler : 'lazy' created with startup=lazy
[junit4] 2> 455951 T2199 c:collection1
oasc.RequestHandlers.initHandlersFromConfig Registered paths:
/admin/mbeans,standard,spellCheckCompRH,lazy,/update/json/docs,/admin/luke,spellCheckWithWordbreak_Direct,tvrh,/get,/admin/properties,/update/json,mltrh,/admin/threads,/search-facet-def,/update/csv,/search-facet-invariants,/admin/segments,spellCheckCompRH1,/mlt,/admin/system,/replication,dismax,defaults,/config,/schema,/admin/plugins,/admin/logging,spellCheckWithWordbreak,mock,/admin/ping,/update,/admin/file,/terms,spellCheckCompRH_Direct,/debug/dump
[junit4] 2> 455952 T2199 c:collection1 oasc.SolrCore.initDeprecatedSupport
WARN solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your
config to use the ShowFileRequestHandler.
[junit4] 2> 455952 T2199 c:collection1 oasc.SolrCore.initStatsCache Using
default statsCache cache: org.apache.solr.search.stats.LocalStatsCache
[junit4] 2> 455953 T2199 c:collection1 oasu.UpdateHandler.<init> Using
UpdateLog implementation: org.apache.solr.update.UpdateLog
[junit4] 2> 455953 T2199 c:collection1 oasu.UpdateLog.init Initializing
UpdateLog: dataDir= defaultSyncLevel=FLUSH numRecordsToKeep=100
maxNumLogsToKeep=10
[junit4] 2> 455954 T2199 c:collection1 oasu.CommitTracker.<init> Hard
AutoCommit: disabled
[junit4] 2> 455954 T2199 c:collection1 oasu.CommitTracker.<init> Soft
AutoCommit: disabled
[junit4] 2> 455955 T2199 c:collection1 oasu.RandomMergePolicy.<init>
RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy:
[TieredMergePolicy: maxMergeAtOnce=15, maxMergeAtOnceExplicit=50,
maxMergedSegmentMB=87.796875, floorSegmentMB=1.8701171875,
forceMergeDeletesPctAllowed=13.647175345651432, segmentsPerTier=49.0,
maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.3462000847861548
[junit4] 2> 455955 T2199 c:collection1 oasc.SolrDeletionPolicy.onInit
SolrDeletionPolicy.onInit: commits: num=1
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_1,generation=1}
[junit4] 2> 455955 T2199 c:collection1
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 455955 T2199 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@138d9b3[collection1] main
[junit4] 2> 455956 T2199 c:collection1 oasr.RestManager.init Initializing
RestManager with initArgs:
{storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
[junit4] 2> 455956 T2199 c:collection1 oasr.ManagedResourceStorage.load
Reading _rest_managed.json using InMemoryStorage
[junit4] 2> 455956 T2199 c:collection1 oasr.RestManager.init Initializing
0 registered ManagedResources
[junit4] 2> 455956 T2199 c:collection1 oashc.SpellCheckComponent.inform
Initializing spell checkers
[junit4] 2> 455964 T2199 c:collection1 oass.DirectSolrSpellChecker.init
init:
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4] 2> 456018 T2199 c:collection1 oash.ReplicationHandler.inform
Commits will be reserved for 10000
[junit4] 2> 456018 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: default
[junit4] 2> 456019 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: direct
[junit4] 2> 456019 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: wordbreak
[junit4] 2> 456019 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: multipleFields
[junit4] 2> 456019 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: jarowinkler
[junit4] 2> 456019 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: external
[junit4] 2> 456020 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: freq
[junit4] 2> 456020 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: fqcn
[junit4] 2> 456020 T2200 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: perDict
[junit4] 2> 456021 T2200 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@138d9b3[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 456021 T2199 c:collection1 oasc.CoreContainer.registerCore
registering core: collection1
[junit4] 2> 456024 T2198 oas.SolrTestCaseJ4.initCore ####initCore end
[junit4] 2> 456030 T2198 oas.SolrTestCaseJ4.setUp ###Starting testMaxTime
[junit4] 2> ASYNC NEW_CORE C857 name=collection1
org.apache.solr.core.SolrCore@563d5d
[junit4] 2> 456034 T2198 C857 oasup.LogUpdateProcessor.finish
[collection1] webapp=null path=null params={} {deleteByQuery=*:*
(-1499380830034722816)} 0 4
[junit4] 2> 456036 T2198 oasc.SolrResourceLoader.<init> new
SolrResourceLoader for directory:
'C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\'
[junit4] 2> 456037 T2198 oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/classes/'
to classloader
[junit4] 2> 456037 T2198 oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/README'
to classloader
[junit4] 2> 456075 T2198 oasc.SolrConfig.refreshRequestParams current
version of requestparams : -1
[junit4] 2> 456094 T2198 oasc.SolrConfig.<init> Using Lucene MatchVersion:
6.0.0
[junit4] 2> 456114 T2198 oasc.SolrConfig.<init> Loaded SolrConfig:
solrconfig.xml
[junit4] 2> 456114 T2198 oass.IndexSchema.readSchema Reading Solr Schema
from
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
[junit4] 2> 456118 T2198 oass.IndexSchema.readSchema [collection1] Schema
name=test
[junit4] 2> 456246 T2198 oass.OpenExchangeRatesOrgProvider.init
Initialized with rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 456256 T2198 oass.IndexSchema.readSchema default search field
in schema is text
[junit4] 2> 456258 T2198 oass.IndexSchema.readSchema unique key field: id
[junit4] 2> 456263 T2198 oass.FileExchangeRateProvider.reload Reloading
exchange rates from file currency.xml
[junit4] 2> 456265 T2198 oass.FileExchangeRateProvider.reload Reloading
exchange rates from file currency.xml
[junit4] 2> 456267 T2198 oass.OpenExchangeRatesOrgProvider.reload
Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 456267 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 456268 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 456268 T2198 oass.OpenExchangeRatesOrgProvider.reload
Reloading exchange rates from open-exchange-rates.json
[junit4] 2> 456269 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 456269 T2198
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 456269 T2198 oasc.CoreContainer.reload Reloading SolrCore
'collection1' using configuration from instancedir
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\
[junit4] 2> 456269 T2198 c:collection1 oasc.SolrCore.<init> [[collection1]
] Opening new SolrCore at
[C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\],
dataDir=[C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\]
[junit4] 2> 456270 T2198 c:collection1 oasc.JmxMonitoredMap.<init> JMX
monitoring is enabled. Adding Solr mbeans to JMX Server:
com.sun.jmx.mbeanserver.JmxMBeanServer@1987ed3
[junit4] 2> 456270 T2198 c:collection1 oasc.SolrCore.getNewIndexDir New
index directory detected: old=null
new=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index/
[junit4] 2> 456276 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe"
[junit4] 2> 456277 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4] 2> 456277 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 456277 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 456277 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"stored_sig"
[junit4] 2> 456277 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4] 2> 456278 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"uniq-fields"
[junit4] 2> 456278 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4] 2> 456278 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-explicit"
[junit4] 2> 456278 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 456279 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 456279 T2198 c:collection1
oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined
as default, creating implicit default
[junit4] 2> 456280 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456281 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456283 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456284 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456288 T2198 c:collection1 oasc.PluginBag.createPlugin
requestHandler : 'lazy' created with startup=lazy
[junit4] 2> 456291 T2198 c:collection1
oasc.RequestHandlers.initHandlersFromConfig Registered paths:
/admin/mbeans,standard,spellCheckCompRH,lazy,/update/json/docs,/admin/luke,spellCheckWithWordbreak_Direct,tvrh,/get,/admin/properties,/update/json,mltrh,/admin/threads,/search-facet-def,/update/csv,/search-facet-invariants,/admin/segments,spellCheckCompRH1,/mlt,/admin/system,/replication,dismax,defaults,/config,/schema,/admin/plugins,/admin/logging,spellCheckWithWordbreak,mock,/admin/ping,/update,/admin/file,/terms,spellCheckCompRH_Direct,/debug/dump
[junit4] 2> 456292 T2198 c:collection1 oasc.SolrCore.initDeprecatedSupport
WARN solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your
config to use the ShowFileRequestHandler.
[junit4] 2> 456292 T2198 c:collection1 oasc.SolrCore.initStatsCache Using
default statsCache cache: org.apache.solr.search.stats.LocalStatsCache
[junit4] 2> 456294 T2198 c:collection1 oasu.CommitTracker.<init> Hard
AutoCommit: disabled
[junit4] 2> 456294 T2198 c:collection1 oasu.CommitTracker.<init> Soft
AutoCommit: disabled
[junit4] 2> 456295 T2198 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@11723b4[collection1] main
[junit4] 2> 456298 T2198 c:collection1 oasr.RestManager.init Initializing
RestManager with initArgs:
{storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
[junit4] 2> 456298 T2198 c:collection1 oasr.ManagedResourceStorage.load
Reading _rest_managed.json using InMemoryStorage
[junit4] 2> 456298 T2198 c:collection1 oasr.RestManager.init Initializing
0 registered ManagedResources
[junit4] 2> 456298 T2198 c:collection1 oashc.SpellCheckComponent.inform
Initializing spell checkers
[junit4] 2> 456300 T2198 c:collection1 oass.DirectSolrSpellChecker.init
init:
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4] 2> 456305 T2198 c:collection1 oash.ReplicationHandler.inform
Commits will be reserved for 10000
[junit4] 2> 456306 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: default
[junit4] 2> 456307 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: direct
[junit4] 2> 456307 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: wordbreak
[junit4] 2> 456307 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: multipleFields
[junit4] 2> 456307 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: jarowinkler
[junit4] 2> 456308 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: external
[junit4] 2> 456308 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: freq
[junit4] 2> 456308 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: fqcn
[junit4] 2> 456309 T2202 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: perDict
[junit4] 2> 456317 T2202 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@11723b4[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 456318 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Creating new IndexWriter...
[junit4] 2> 456318 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Waiting until IndexWriter is unused...
core=collection1
[junit4] 2> 456318 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Closing old IndexWriter...
core=collection1
[junit4] 2> 456319 T2198 c:collection1 oasu.RandomMergePolicy.<init>
RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=22, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.37259925831552565]
[junit4] 2> 456319 T2198 c:collection1 oasc.SolrDeletionPolicy.onInit
SolrDeletionPolicy.onInit: commits: num=1
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_1,generation=1}
[junit4] 2> 456325 T2198 c:collection1
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 1
[junit4] 2> 456325 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter New IndexWriter is ready to be used.
[junit4] 2> 456326 T2198 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@a42e0e[collection1] main
[junit4] 2> 456326 T2198 c:collection1 oasc.CoreContainer.registerCore
replacing core: collection1
[junit4] 2> 456326 T2198 c:collection1 oasc.SolrCore.close [collection1]
CLOSING SolrCore org.apache.solr.core.SolrCore@563d5d
[junit4] 2> 456327 T2198 c:collection1 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=1,errors=0,cumulative_adds=0,cumulative_deletesById=0,cumulative_deletesByQuery=1,cumulative_errors=0,transaction_logs_total_size=0,transaction_logs_total_number=0}
[junit4] 2> 456330 T2198 c:collection1 oasc.SolrCore.closeSearcher
[collection1] Closing main searcher on request.
[junit4] 2> 456343 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[529 (1499380830361878528)]} 0 1
[junit4] 2> ASYNC NEW_CORE C858 name=collection1
org.apache.solr.core.SolrCore@118b3fd
[junit4] 2> 456344 T2198 c:collection1 C858 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:529&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=0
[junit4] 2> 456346 T2202 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@a42e0e[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 456603 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[530 (1499380830635556864)]} 0 261
[junit4] 2> 456604 T2198 c:collection1 C858 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:529&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=0
[junit4] 2> 456606 T2198 c:collection1 oas.SolrTestCaseJ4.assertQ ERROR
REQUEST FAILED: xpath=//result[@numFound=1]
[junit4] 2> xml response was: <?xml version="1.0"
encoding="UTF-8"?>
[junit4] 2> <response>
[junit4] 2> <lst name="responseHeader"><int
name="status">0</int><int name="QTime">0</int></lst><result name="response"
numFound="0" start="0"></result>
[junit4] 2> </response>
[junit4] 2>
[junit4] 2> request
was:q=id:529&qt=standard&start=0&rows=20&version=2.2
[junit4] 2> 456607 T2198 c:collection1 oasc.SolrException.log ERROR
REQUEST FAILED:
q=id:529&qt=standard&start=0&rows=20&version=2.2:java.lang.RuntimeException:
REQUEST FAILED: xpath=//result[@numFound=1]
[junit4] 2> xml response was: <?xml version="1.0"
encoding="UTF-8"?>
[junit4] 2> <response>
[junit4] 2> <lst name="responseHeader"><int
name="status">0</int><int name="QTime">0</int></lst><result name="response"
numFound="0" start="0"></result>
[junit4] 2> </response>
[junit4] 2>
[junit4] 2> request
was:q=id:529&qt=standard&start=0&rows=20&version=2.2
[junit4] 2> at
org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:787)
[junit4] 2> at
org.apache.solr.update.AutoCommitTest.testMaxTime(AutoCommitTest.java:237)
[junit4] 2> at
sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
[junit4] 2> at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
[junit4] 2> at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
[junit4] 2> at
java.lang.reflect.Method.invoke(Method.java:497)
[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>
[junit4] 2> 456608 T2198 c:collection1 oas.SolrTestCaseJ4.tearDown
###Ending testMaxTime
[junit4] 2> NOTE: reproduce with: ant test -Dtestcase=AutoCommitTest
-Dtests.method=testMaxTime -Dtests.seed=709987D71C07735C -Dtests.slow=true
-Dtests.locale=sk_SK -Dtests.timezone=SystemV/MST7MDT -Dtests.asserts=true
-Dtests.file.encoding=Cp1252
[junit4] ERROR 0.59s J1 | AutoCommitTest.testMaxTime <<<
[junit4] > Throwable #1: java.lang.RuntimeException: Exception during
query
[junit4] > at
__randomizedtesting.SeedInfo.seed([709987D71C07735C:EA6DFA35829DEF60]:0)
[junit4] > at
org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:794)
[junit4] > at
org.apache.solr.update.AutoCommitTest.testMaxTime(AutoCommitTest.java:237)
[junit4] > at java.lang.Thread.run(Thread.java:745)
[junit4] > Caused by: java.lang.RuntimeException: REQUEST FAILED:
xpath=//result[@numFound=1]
[junit4] > xml response was: <?xml version="1.0" encoding="UTF-8"?>
[junit4] > <response>
[junit4] > <lst name="responseHeader"><int name="status">0</int><int
name="QTime">0</int></lst><result name="response" numFound="0"
start="0"></result>
[junit4] > </response>
[junit4] > request
was:q=id:529&qt=standard&start=0&rows=20&version=2.2
[junit4] > at
org.apache.solr.SolrTestCaseJ4.assertQ(SolrTestCaseJ4.java:787)
[junit4] > ... 40 more
[junit4] 2> 456616 T2198 c:collection1 oas.SolrTestCaseJ4.setUp
###Starting testCommitWithin
[junit4] 2> 456626 T2198 c:collection1 C858 oass.SolrIndexSearcher.<init>
Opening Searcher@1014d1d[collection1] realtime
[junit4] 2> 456627 T2198 c:collection1 C858
oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={}
{deleteByQuery=*:* (-1499380830652334080)} 0 11
[junit4] 2> 456627 T2198 c:collection1 oasc.SolrResourceLoader.<init> new
SolrResourceLoader for directory:
'C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\'
[junit4] 2> 456628 T2198 c:collection1
oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/classes/'
to classloader
[junit4] 2> 456628 T2198 c:collection1
oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/README'
to classloader
[junit4] 2> 456671 T2198 c:collection1
oasc.SolrConfig.refreshRequestParams current version of requestparams : -1
[junit4] 2> 456677 T2198 c:collection1 oasc.SolrConfig.<init> Using Lucene
MatchVersion: 6.0.0
[junit4] 2> 456696 T2198 c:collection1 oasc.SolrConfig.<init> Loaded
SolrConfig: solrconfig.xml
[junit4] 2> 456697 T2198 c:collection1 oass.IndexSchema.readSchema Reading
Solr Schema from
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
[junit4] 2> 456701 T2198 c:collection1 oass.IndexSchema.readSchema
[collection1] Schema name=test
[junit4] 2> 456814 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider.init Initialized with
rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 456819 T2198 c:collection1 oass.IndexSchema.readSchema default
search field in schema is text
[junit4] 2> 456820 T2198 c:collection1 oass.IndexSchema.readSchema unique
key field: id
[junit4] 2> 456824 T2198 c:collection1
oass.FileExchangeRateProvider.reload Reloading exchange rates from file
currency.xml
[junit4] 2> 456827 T2198 c:collection1
oass.FileExchangeRateProvider.reload Reloading exchange rates from file
currency.xml
[junit4] 2> 456829 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from
open-exchange-rates.json
[junit4] 2> 456829 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 456829 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 456830 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from
open-exchange-rates.json
[junit4] 2> 456830 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 456830 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 456830 T2198 c:collection1 oasc.CoreContainer.reload Reloading
SolrCore 'collection1' using configuration from instancedir
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\
[junit4] 2> 456830 T2198 c:collection1 oasc.SolrCore.<init> [[collection1]
] Opening new SolrCore at
[C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\],
dataDir=[C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\]
[junit4] 2> 456831 T2198 c:collection1 oasc.JmxMonitoredMap.<init> JMX
monitoring is enabled. Adding Solr mbeans to JMX Server:
com.sun.jmx.mbeanserver.JmxMBeanServer@1987ed3
[junit4] 2> 456831 T2198 c:collection1 oasc.SolrCore.getNewIndexDir New
index directory detected: old=null
new=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index/
[junit4] 2> 456835 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe"
[junit4] 2> 456835 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4] 2> 456835 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 456836 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 456836 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"stored_sig"
[junit4] 2> 456836 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4] 2> 456836 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"uniq-fields"
[junit4] 2> 456836 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4] 2> 456837 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-explicit"
[junit4] 2> 456837 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 456837 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 456837 T2198 c:collection1
oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined
as default, creating implicit default
[junit4] 2> 456840 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456841 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456843 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456844 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 456848 T2198 c:collection1 oasc.PluginBag.createPlugin
requestHandler : 'lazy' created with startup=lazy
[junit4] 2> 456852 T2198 c:collection1
oasc.RequestHandlers.initHandlersFromConfig Registered paths:
/admin/mbeans,standard,spellCheckCompRH,lazy,/update/json/docs,/admin/luke,spellCheckWithWordbreak_Direct,tvrh,/get,/admin/properties,/update/json,mltrh,/admin/threads,/search-facet-def,/update/csv,/search-facet-invariants,/admin/segments,spellCheckCompRH1,/mlt,/admin/system,/replication,dismax,defaults,/config,/schema,/admin/plugins,/admin/logging,spellCheckWithWordbreak,mock,/admin/ping,/update,/admin/file,/terms,spellCheckCompRH_Direct,/debug/dump
[junit4] 2> 456853 T2198 c:collection1 oasc.SolrCore.initDeprecatedSupport
WARN solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your
config to use the ShowFileRequestHandler.
[junit4] 2> 456854 T2198 c:collection1 oasc.SolrCore.initStatsCache Using
default statsCache cache: org.apache.solr.search.stats.LocalStatsCache
[junit4] 2> 456855 T2198 c:collection1 oasu.CommitTracker.<init> Hard
AutoCommit: disabled
[junit4] 2> 456855 T2198 c:collection1 oasu.CommitTracker.<init> Soft
AutoCommit: disabled
[junit4] 2> 456855 T2198 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@136028f[collection1] main
[junit4] 2> 456856 T2198 c:collection1 oasr.RestManager.init Initializing
RestManager with initArgs:
{storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
[junit4] 2> 456856 T2198 c:collection1 oasr.ManagedResourceStorage.load
Reading _rest_managed.json using InMemoryStorage
[junit4] 2> 456856 T2198 c:collection1 oasr.RestManager.init Initializing
0 registered ManagedResources
[junit4] 2> 456856 T2198 c:collection1 oashc.SpellCheckComponent.inform
Initializing spell checkers
[junit4] 2> 456857 T2198 c:collection1 oass.DirectSolrSpellChecker.init
init:
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4] 2> 456863 T2198 c:collection1 oash.ReplicationHandler.inform
Commits will be reserved for 10000
[junit4] 2> 456863 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Creating new IndexWriter...
[junit4] 2> 456864 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Waiting until IndexWriter is unused...
core=collection1
[junit4] 2> 456864 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Closing old IndexWriter...
core=collection1
[junit4] 2> 456864 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: default
[junit4] 2> 456865 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: direct
[junit4] 2> 456865 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: wordbreak
[junit4] 2> 456865 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: multipleFields
[junit4] 2> 456865 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: jarowinkler
[junit4] 2> 456866 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: external
[junit4] 2> 456866 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: freq
[junit4] 2> 456866 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: fqcn
[junit4] 2> 456867 T2204 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: perDict
[junit4] 2> 456867 T2198 c:collection1 oasc.SolrDeletionPolicy.onCommit
SolrDeletionPolicy.onCommit: commits: num=2
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_1,generation=1}
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_2,generation=2}
[junit4] 2> 456867 T2198 c:collection1
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 2
[junit4] 2> 456868 T2204 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@136028f[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 456869 T2198 c:collection1 oasu.RandomMergePolicy.<init>
RandomMergePolicy wrapping class
org.apache.lucene.index.LogByteSizeMergePolicy: [LogByteSizeMergePolicy:
minMergeSize=1677721, mergeFactor=35, maxMergeSize=2147483648,
maxMergeSizeForForcedMerge=9223372036854775807, calibrateSizeByDeletes=false,
maxMergeDocs=2147483647, maxCFSSegmentSizeMB=8.796093022207999E12,
noCFSRatio=0.7715990416153077]
[junit4] 2> 456869 T2198 c:collection1 oasc.SolrDeletionPolicy.onInit
SolrDeletionPolicy.onInit: commits: num=1
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_2,generation=2}
[junit4] 2> 456869 T2198 c:collection1
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 2
[junit4] 2> 456870 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter New IndexWriter is ready to be used.
[junit4] 2> 456870 T2198 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@990b77[collection1] main
[junit4] 2> 456871 T2204 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@990b77[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 456871 T2198 c:collection1 oasc.CoreContainer.registerCore
replacing core: collection1
[junit4] 2> 456871 T2198 c:collection1 oasc.SolrCore.close [collection1]
CLOSING SolrCore org.apache.solr.core.SolrCore@118b3fd
[junit4] 2> 456871 T2198 c:collection1 oasu.DirectUpdateHandler2.close
closing DirectUpdateHandler2{commits=0,autocommits=0,soft autocommit
maxTime=1000ms,soft
autocommits=0,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=2,adds=2,deletesById=0,deletesByQuery=1,errors=0,cumulative_adds=2,cumulative_deletesById=0,cumulative_deletesByQuery=1,cumulative_errors=0,transaction_logs_total_size=0,transaction_logs_total_number=0}
[junit4] 2> 456876 T2198 c:collection1 oasc.SolrCore.closeSearcher
[collection1] Closing main searcher on request.
[junit4] 2> 456885 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[529 (1499380830930206720)]} 0 1
[junit4] 2> ASYNC NEW_CORE C859 name=collection1
org.apache.solr.core.SolrCore@6ca1a3
[junit4] 2> 456886 T2198 c:collection1 C859 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:529&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=1
[junit4] 2> 461026 T2205 c:collection1 oasu.DirectUpdateHandler2.commit
start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=true,prepareCommit=false}
[junit4] 2> 461034 T2205 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@df6baf[collection1] main
[junit4] 2> 461035 T2205 c:collection1 oasu.DirectUpdateHandler2.commit
end_commit_flush
[junit4] 2> 461037 T2204 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@df6baf[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_1(6.0.0):c1)))}
[junit4] 2> 461205 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[530 (1499380835460055040)]} 0 4321
[junit4] 2> 461207 T2198 c:collection1 C859 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:530&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=0
[junit4] 2> 461209 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[529 (-1499380835465297920)]} 0 4325
[junit4] 2> 461209 T2198 c:collection1 C859 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:529&qt=standard&start=0&rows=20&version=2.2} hits=1 status=0
QTime=0
[junit4] 2> 462324 T2205 c:collection1 oasu.DirectUpdateHandler2.commit
start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=true,prepareCommit=false}
[junit4] 2> 462334 T2205 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@17876fb[collection1] main
[junit4] 2> 462335 T2205 c:collection1 oasu.DirectUpdateHandler2.commit
end_commit_flush
[junit4] 2> 462336 T2204 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@17876fb[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_2(6.0.0):c1)))}
[junit4] 2> ASYNC NEW_CORE C860 name=collection1
org.apache.solr.core.SolrCore@6ca1a3
[junit4] 2> 462617 T2198 c:collection1 C860 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:529&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=0
[junit4] 2> 462619 T2198 c:collection1 C860 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:530&qt=standard&start=0&rows=20&version=2.2} hits=1 status=0
QTime=0
[junit4] 2> 462620 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836943790080)]} 0 5736
[junit4] 2> 462620 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836944838656)]} 0 5736
[junit4] 2> 462621 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836945887232)]} 0 5737
[junit4] 2> 462621 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836945887233)]} 0 5737
[junit4] 2> 462621 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836945887234)]} 0 5737
[junit4] 2> 462622 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836946935808)]} 0 5738
[junit4] 2> 462622 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836946935809)]} 0 5738
[junit4] 2> 462622 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836946935810)]} 0 5738
[junit4] 2> 462623 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836947984384)]} 0 5739
[junit4] 2> 462623 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[500 (1499380836947984385)]} 0 5739
[junit4] 2> 462623 T2198 c:collection1 C860 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:500&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=0
[junit4] 2> 462625 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836950081536)]} 0 5741
[junit4] 2> 462625 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836950081537)]} 0 5741
[junit4] 2> 462625 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836950081538)]} 0 5741
[junit4] 2> 462626 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836951130112)]} 0 5742
[junit4] 2> 462626 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836951130113)]} 0 5742
[junit4] 2> 462627 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836952178688)]} 0 5743
[junit4] 2> 462627 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836952178689)]} 0 5743
[junit4] 2> 462628 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836953227264)]} 0 5744
[junit4] 2> 462628 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836953227265)]} 0 5744
[junit4] 2> 462628 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {delete=[530 (-1499380836953227266)]} 0 5744
[junit4] 2> 462628 T2198 c:collection1 C860 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:530&qt=standard&start=0&rows=20&version=2.2} hits=1 status=0
QTime=0
[junit4] 2> 463764 T2205 c:collection1 oasu.DirectUpdateHandler2.commit
start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=true,prepareCommit=false}
[junit4] 2> 463768 T2205 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@8907d8[collection1] main
[junit4] 2> 463768 T2205 c:collection1 oasu.DirectUpdateHandler2.commit
end_commit_flush
[junit4] 2> 463769 T2204 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@8907d8[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_3(6.0.0):c10/9:delGen=1)))}
[junit4] 2> 463773 T2198 c:collection1 C860 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:500&qt=standard&start=0&rows=20&version=2.2} hits=1 status=0
QTime=0
[junit4] 2> 463775 T2198 c:collection1 C860 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:530&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=1
[junit4] 2> 463775 T2198 c:collection1 oas.SolrTestCaseJ4.tearDown
###Ending testCommitWithin
[junit4] 2> 463780 T2198 c:collection1 oas.SolrTestCaseJ4.setUp
###Starting testMaxDocs
[junit4] 2> 463785 T2198 c:collection1 C860 oass.SolrIndexSearcher.<init>
Opening Searcher@15334c0[collection1] realtime
[junit4] 2> 463785 T2198 c:collection1 C860
oasup.LogUpdateProcessor.finish [collection1] webapp=null path=null params={}
{deleteByQuery=*:* (-1499380838163283968)} 0 5
[junit4] 2> 463785 T2198 c:collection1 oasc.SolrResourceLoader.<init> new
SolrResourceLoader for directory:
'C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\'
[junit4] 2> 463786 T2198 c:collection1
oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/classes/'
to classloader
[junit4] 2> 463786 T2198 c:collection1
oasc.SolrResourceLoader.replaceClassLoader Adding
'file:/C:/Users/JenkinsSlave/workspace/Lucene-Solr-trunk-Windows/solr/core/src/test-files/solr/collection1/lib/README'
to classloader
[junit4] 2> 463810 T2198 c:collection1
oasc.SolrConfig.refreshRequestParams current version of requestparams : -1
[junit4] 2> 463823 T2198 c:collection1 oasc.SolrConfig.<init> Using Lucene
MatchVersion: 6.0.0
[junit4] 2> 463844 T2198 c:collection1 oasc.SolrConfig.<init> Loaded
SolrConfig: solrconfig.xml
[junit4] 2> 463845 T2198 c:collection1 oass.IndexSchema.readSchema Reading
Solr Schema from
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\conf\schema.xml
[junit4] 2> 463849 T2198 c:collection1 oass.IndexSchema.readSchema
[collection1] Schema name=test
[junit4] 2> 463967 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider.init Initialized with
rates=open-exchange-rates.json, refreshInterval=1440.
[junit4] 2> 463976 T2198 c:collection1 oass.IndexSchema.readSchema default
search field in schema is text
[junit4] 2> 463976 T2198 c:collection1 oass.IndexSchema.readSchema unique
key field: id
[junit4] 2> 463982 T2198 c:collection1
oass.FileExchangeRateProvider.reload Reloading exchange rates from file
currency.xml
[junit4] 2> 463985 T2198 c:collection1
oass.FileExchangeRateProvider.reload Reloading exchange rates from file
currency.xml
[junit4] 2> 463986 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from
open-exchange-rates.json
[junit4] 2> 463987 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 463987 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 463987 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider.reload Reloading exchange rates from
open-exchange-rates.json
[junit4] 2> 463988 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Unknown key
IMPORTANT NOTE
[junit4] 2> 463988 T2198 c:collection1
oass.OpenExchangeRatesOrgProvider$OpenExchangeRates.<init> WARN Expected key,
got STRING
[junit4] 2> 463988 T2198 c:collection1 oasc.CoreContainer.reload Reloading
SolrCore 'collection1' using configuration from instancedir
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\
[junit4] 2> 463988 T2198 c:collection1 oasc.SolrCore.<init> [[collection1]
] Opening new SolrCore at
[C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\core\src\test-files\solr\collection1\],
dataDir=[C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\]
[junit4] 2> 463988 T2198 c:collection1 oasc.JmxMonitoredMap.<init> JMX
monitoring is enabled. Adding Solr mbeans to JMX Server:
com.sun.jmx.mbeanserver.JmxMBeanServer@1987ed3
[junit4] 2> 463990 T2198 c:collection1 oasc.SolrCore.getNewIndexDir New
index directory detected: old=null
new=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index/
[junit4] 2> 463993 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe"
[junit4] 2> 463994 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "dedupe"
[junit4] 2> 463994 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 463994 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"dedupe-allfields"
[junit4] 2> 463994 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"stored_sig"
[junit4] 2> 463995 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "stored_sig"
[junit4] 2> 463995 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"uniq-fields"
[junit4] 2> 463995 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain "uniq-fields"
[junit4] 2> 463996 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-explicit"
[junit4] 2> 463996 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init creating updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 463996 T2198 c:collection1
oasup.UpdateRequestProcessorChain.init inserting
DistributedUpdateProcessorFactory into updateRequestProcessorChain
"distrib-dup-test-chain-implicit"
[junit4] 2> 463996 T2198 c:collection1
oasc.SolrCore.loadUpdateProcessorChains no updateRequestProcessorChain defined
as default, creating implicit default
[junit4] 2> 463998 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 464000 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 464001 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 464002 T2198 c:collection1 oashl.XMLLoader.init
xsltCacheLifetimeSeconds=60
[junit4] 2> 464007 T2198 c:collection1 oasc.PluginBag.createPlugin
requestHandler : 'lazy' created with startup=lazy
[junit4] 2> 464011 T2198 c:collection1
oasc.RequestHandlers.initHandlersFromConfig Registered paths:
/admin/mbeans,standard,spellCheckCompRH,lazy,/update/json/docs,/admin/luke,spellCheckWithWordbreak_Direct,tvrh,/get,/admin/properties,/update/json,mltrh,/admin/threads,/search-facet-def,/update/csv,/search-facet-invariants,/admin/segments,spellCheckCompRH1,/mlt,/admin/system,/replication,dismax,defaults,/config,/schema,/admin/plugins,/admin/logging,spellCheckWithWordbreak,mock,/admin/ping,/update,/admin/file,/terms,spellCheckCompRH_Direct,/debug/dump
[junit4] 2> 464011 T2198 c:collection1 oasc.SolrCore.initDeprecatedSupport
WARN solrconfig.xml uses deprecated <admin/gettableFiles>, Please update your
config to use the ShowFileRequestHandler.
[junit4] 2> 464012 T2198 c:collection1 oasc.SolrCore.initStatsCache Using
default statsCache cache: org.apache.solr.search.stats.LocalStatsCache
[junit4] 2> 464012 T2198 c:collection1 oasu.CommitTracker.<init> Hard
AutoCommit: disabled
[junit4] 2> 464013 T2198 c:collection1 oasu.CommitTracker.<init> Soft
AutoCommit: disabled
[junit4] 2> 464013 T2198 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@555da2[collection1] main
[junit4] 2> 464013 T2198 c:collection1 oasr.RestManager.init Initializing
RestManager with initArgs:
{storageIO=org.apache.solr.rest.ManagedResourceStorage$InMemoryStorageIO}
[junit4] 2> 464013 T2198 c:collection1 oasr.ManagedResourceStorage.load
Reading _rest_managed.json using InMemoryStorage
[junit4] 2> 464013 T2198 c:collection1 oasr.RestManager.init Initializing
0 registered ManagedResources
[junit4] 2> 464015 T2198 c:collection1 oashc.SpellCheckComponent.inform
Initializing spell checkers
[junit4] 2> 464016 T2198 c:collection1 oass.DirectSolrSpellChecker.init
init:
{name=direct,classname=DirectSolrSpellChecker,field=lowerfilt,minQueryLength=3}
[junit4] 2> 464021 T2198 c:collection1 oash.ReplicationHandler.inform
Commits will be reserved for 10000
[junit4] 2> 464021 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: default
[junit4] 2> 464022 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: direct
[junit4] 2> 464022 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Creating new IndexWriter...
[junit4] 2> 464022 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Waiting until IndexWriter is unused...
core=collection1
[junit4] 2> 464022 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter Closing old IndexWriter...
core=collection1
[junit4] 2> 464022 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: wordbreak
[junit4] 2> 464022 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: multipleFields
[junit4] 2> 464022 T2198 c:collection1 oasc.SolrDeletionPolicy.onCommit
SolrDeletionPolicy.onCommit: commits: num=2
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_2,generation=2}
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_3,generation=3}
[junit4] 2> 464023 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: jarowinkler
[junit4] 2> 464023 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: external
[junit4] 2> 464024 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: freq
[junit4] 2> 464024 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: fqcn
[junit4] 2> 464025 T2206 c:collection1
oashc.SpellCheckComponent$SpellCheckerListener.newSearcher Loading spell index
for spellchecker: perDict
[junit4] 2> 464025 T2206 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@555da2[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 464023 T2198 c:collection1
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 3
[junit4] 2> 464026 T2198 c:collection1 oasu.RandomMergePolicy.<init>
RandomMergePolicy wrapping class org.apache.lucene.index.TieredMergePolicy:
[TieredMergePolicy: maxMergeAtOnce=34, maxMergeAtOnceExplicit=42,
maxMergedSegmentMB=97.654296875, floorSegmentMB=0.4736328125,
forceMergeDeletesPctAllowed=3.704067440971076, segmentsPerTier=16.0,
maxCFSSegmentSizeMB=8.796093022207999E12, noCFSRatio=0.0
[junit4] 2> 464029 T2198 c:collection1 oasc.SolrDeletionPolicy.onInit
SolrDeletionPolicy.onInit: commits: num=1
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_3,generation=3}
[junit4] 2> 464029 T2198 c:collection1
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 3
[junit4] 2> 464030 T2198 c:collection1
oasu.DefaultSolrCoreState.newIndexWriter New IndexWriter is ready to be used.
[junit4] 2> 464030 T2198 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@1862d00[collection1] main
[junit4] 2> 464031 T2198 c:collection1 oasc.CoreContainer.registerCore
replacing core: collection1
[junit4] 2> 464031 T2198 c:collection1 oasc.SolrCore.close [collection1]
CLOSING SolrCore org.apache.solr.core.SolrCore@6ca1a3
[junit4] 2> 464031 T2206 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@1862d00[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
[junit4] 2> 464031 T2198 c:collection1 oasu.DirectUpdateHandler2.close
closing DirectUpdateHandler2{commits=3,autocommits=0,soft
autocommits=3,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=12,adds=0,deletesById=0,deletesByQuery=1,errors=0,cumulative_adds=12,cumulative_deletesById=11,cumulative_deletesByQuery=1,cumulative_errors=0,transaction_logs_total_size=0,transaction_logs_total_number=0}
[junit4] 2> 464032 T2198 c:collection1 oasc.SolrCore.closeSearcher
[collection1] Closing main searcher on request.
[junit4] 2> 464047 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[0 (1499380838441156608)]} 0 0
[junit4] 2> 464049 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[1 (1499380838443253760)]} 0 2
[junit4] 2> 464049 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[2 (1499380838443253761)]} 0 2
[junit4] 2> 464050 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[3 (1499380838443253762)]} 0 3
[junit4] 2> 464050 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[4 (1499380838444302336)]} 0 3
[junit4] 2> 464050 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[5 (1499380838444302337)]} 0 3
[junit4] 2> 464051 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[6 (1499380838445350912)]} 0 4
[junit4] 2> 464051 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[7 (1499380838445350913)]} 0 4
[junit4] 2> 464052 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[8 (1499380838446399488)]} 0 5
[junit4] 2> 464052 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[9 (1499380838446399489)]} 0 5
[junit4] 2> 464053 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[10 (1499380838447448064)]} 0 6
[junit4] 2> 464053 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[11 (1499380838447448065)]} 0 6
[junit4] 2> 464054 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[12 (1499380838448496640)]} 0 7
[junit4] 2> 464054 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[13 (1499380838448496641)]} 0 7
[junit4] 2> ASYNC NEW_CORE C861 name=collection1
org.apache.solr.core.SolrCore@1ea098b
[junit4] 2> 464054 T2198 c:collection1 C861 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:1&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0 QTime=0
[junit4] 2> 464055 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[14 (1499380838449545216)]} 0 8
[junit4] 2> 464057 T2207 c:collection1 oasu.DirectUpdateHandler2.commit
start
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=true,prepareCommit=false}
[junit4] 2> 464067 T2207 c:collection1 oass.SolrIndexSearcher.<init>
Opening Searcher@1426627[collection1] main
[junit4] 2> 464067 T2207 c:collection1 oasu.DirectUpdateHandler2.commit
end_commit_flush
[junit4] 2> 464069 T2206 c:collection1 oasc.SolrCore.registerSearcher
[collection1] Registered new searcher Searcher@1426627[collection1]
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_4(6.0.0):c15)))}
[junit4] 2> 464340 T2198 c:collection1 oasup.LogUpdateProcessor.finish
[collection1] {add=[15 (1499380838748389376)]} 0 293
[junit4] 2> 464341 T2198 c:collection1 C861 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:14&qt=standard&start=0&rows=20&version=2.2} hits=1 status=0
QTime=0
[junit4] 2> 464342 T2198 c:collection1 C861 oasc.SolrCore.execute
[collection1] webapp=null path=null
params={q=id:15&qt=standard&start=0&rows=20&version=2.2} hits=0 status=0
QTime=0
[junit4] 2> 464342 T2198 c:collection1 oas.SolrTestCaseJ4.tearDown
###Ending testMaxDocs
[junit4] 2> 464343 T2198 c:collection1 oas.SolrTestCaseJ4.deleteCore
###deleteCore
[junit4] 2> 464344 T2198 c:collection1 oasc.CoreContainer.shutdown
Shutting down CoreContainer instance=17608848
[junit4] 2> 464344 T2198 c:collection1 oasc.SolrCore.close [collection1]
CLOSING SolrCore org.apache.solr.core.SolrCore@1ea098b
[junit4] 2> 464344 T2198 c:collection1 oasu.DirectUpdateHandler2.close
closing DirectUpdateHandler2{commits=1,autocommits=0,soft autocommit
maxDocs=14,soft
autocommits=1,optimizes=0,rollbacks=0,expungeDeletes=0,docsPending=16,adds=1,deletesById=0,deletesByQuery=0,errors=0,cumulative_adds=16,cumulative_deletesById=0,cumulative_deletesByQuery=0,cumulative_errors=0,transaction_logs_total_size=0,transaction_logs_total_number=0}
[junit4] 2> 464346 T2198 c:collection1
oasu.SolrCoreState.decrefSolrCoreState Closing SolrCoreState
[junit4] 2> 464346 T2198 c:collection1
oasu.DefaultSolrCoreState.closeIndexWriter SolrCoreState ref count has reached
0 - closing IndexWriter
[junit4] 2> 464346 T2198 c:collection1
oasu.DefaultSolrCoreState.closeIndexWriter closing IndexWriter with
IndexWriterCloser
[junit4] 2> 464346 T2198 c:collection1 C861
oasu.DirectUpdateHandler2.closeWriter Committing on IndexWriter close.
[junit4] 2> 464351 T2198 c:collection1 C861
oasc.SolrDeletionPolicy.onCommit SolrDeletionPolicy.onCommit: commits: num=2
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_3,generation=3}
[junit4] 2>
commit{dir=MockDirectoryWrapper(RAMDirectory@1ccc2f3
lockFactory=org.apache.lucene.store.SingleInstanceLockFactory@6d6f68),segFN=segments_4,generation=4}
[junit4] 2> 464351 T2198 c:collection1 C861
oasc.SolrDeletionPolicy.updateCommits newest commit generation = 4
[junit4] 2> 464352 T2198 c:collection1 oasc.SolrCore.closeSearcher
[collection1] Closing main searcher on request.
[junit4] 2> 464368 T2198 c:collection1 oasc.CachingDirectoryFactory.close
Closing MockDirectoryFactory - 2 directories currently being tracked
[junit4] 2> 464368 T2198 c:collection1
oasc.CachingDirectoryFactory.closeCacheValue looking to close
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index
[CachedDir<<refCount=0;path=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index;done=false>>]
[junit4] 2> 464369 T2198 c:collection1 oasc.CachingDirectoryFactory.close
Closing directory:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\index
[junit4] 2> 464369 T2198 c:collection1
oasc.CachingDirectoryFactory.closeCacheValue looking to close
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\
[CachedDir<<refCount=0;path=C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\;done=false>>]
[junit4] 2> 464369 T2198 c:collection1 oasc.CachingDirectoryFactory.close
Closing directory:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001\init-core-data-001\
[junit4] 2> NOTE: leaving temporary files on disk at:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build\solr-core\test\J1\temp\solr.update.AutoCommitTest
709987D71C07735C-001
[junit4] 2> NOTE: test params are: codec=Asserting(Lucene50):
{range_facet_l_dv=PostingsFormat(name=LuceneVarGapFixedInterval),
_version_=BlockTreeOrds(blocksize=128),
field_t=PostingsFormat(name=LuceneVarGapFixedInterval),
multiDefault=PostingsFormat(name=Memory doPackFST= true),
subject=PostingsFormat(name=Memory doPackFST= true),
intDefault=BlockTreeOrds(blocksize=128),
id=PostingsFormat(name=LuceneVarGapFixedInterval),
range_facet_i_dv=PostingsFormat(name=Memory doPackFST= true), text=FSTOrd50,
range_facet_l=PostingsFormat(name=Memory doPackFST= true),
timestamp=PostingsFormat(name=Memory doPackFST= true)},
docValues:{range_facet_l_dv=DocValuesFormat(name=Memory),
range_facet_i_dv=DocValuesFormat(name=Lucene50),
timestamp=DocValuesFormat(name=Lucene50)}, sim=DefaultSimilarity, locale=sk_SK,
timezone=SystemV/MST7MDT
[junit4] 2> NOTE: Windows 7 6.1 x86/Oracle Corporation 1.8.0_40
(32-bit)/cpus=3,threads=1,free=65279984,total=108138496
[junit4] 2> NOTE: All tests run in this JVM: [TestCollapseQParserPlugin,
ResourceLoaderTest, BasicZkTest, IndexSchemaTest, BufferStoreTest,
UpdateRequestProcessorFactoryTest, TestCursorMarkWithoutUniqueKey,
DebugComponentTest, TestSolrDeletionPolicy1, QueryParsingTest,
PreAnalyzedUpdateProcessorTest, TestMergePolicyConfig, ConnectionManagerTest,
TestSimpleQParserPlugin, TestRangeQuery, TestLMJelinekMercerSimilarityFactory,
BinaryUpdateRequestHandlerTest, OverseerStatusTest, BasicDistributedZk2Test,
TestDocSet, ShardSplitTest, XsltUpdateRequestHandlerTest, AddBlockUpdateTest,
TestMissingGroups, TestEmbeddedSolrServerConstructors,
TestSchemaSimilarityResource, TestCodecSupport, DistributedTermsComponentTest,
TestSystemIdResolver, TestRecovery, CollectionsAPIDistributedZkTest,
TestJsonFacets, SuggesterTSTTest, TestRequestStatusCollectionAPI,
TestManagedStopFilterFactory, DirectSolrSpellCheckerTest, AutoCommitTest]
[junit4] Completed [98/484] on J1 in 9.00s, 3 tests, 1 error <<< FAILURES!
[...truncated 1215 lines...]
BUILD FAILED
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\build.xml:526: The
following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\build.xml:474: The
following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\build.xml:61: The
following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\extra-targets.xml:39:
The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\build.xml:229:
The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\solr\common-build.xml:512:
The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\lucene\common-build.xml:1415:
The following error occurred while executing this line:
C:\Users\JenkinsSlave\workspace\Lucene-Solr-trunk-Windows\lucene\common-build.xml:973:
There were test failures: 484 suites, 1944 tests, 1 error, 63 ignored (34
assumptions)
Total time: 60 minutes 37 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
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]
