Build: https://jenkins.thetaphi.de/job/Lucene-Solr-7.x-Windows/663/
Java: 64bit/jdk1.8.0_172 -XX:-UseCompressedOops -XX:+UseConcMarkSweepGC

1 tests failed.
FAILED:  
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd.testFullImport

Error Message:
Could not remove the following files (in the order of attempts):    
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005\collection1:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005\collection1
    
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005
 

Stack Trace:
java.io.IOException: Could not remove the following files (in the order of 
attempts):
   
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005\collection1:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005\collection1
   
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005:
 java.nio.file.DirectoryNotEmptyException: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-005

        at 
__randomizedtesting.SeedInfo.seed([E17AE71AE5517447:64D69A815D5EEA67]:0)
        at org.apache.lucene.util.IOUtils.rm(IOUtils.java:318)
        at 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd$SolrInstance.tearDown(TestSolrEntityProcessorEndToEnd.java:360)
        at 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd.tearDown(TestSolrEntityProcessorEndToEnd.java:142)
        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:498)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:992)
        at 
com.carrotsearch.randomizedtesting.rules.SystemPropertiesRestoreRule$1.evaluate(SystemPropertiesRestoreRule.java:57)
        at 
org.apache.lucene.util.TestRuleSetupTeardownChained$1.evaluate(TestRuleSetupTeardownChained.java:49)
        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
        at 
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:943)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
        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:45)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
        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:53)
        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
        at 
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
        at java.lang.Thread.run(Thread.java:748)




Build Log:
[...truncated 21204 lines...]
   [junit4] Suite: 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd
   [junit4]   2> Creating dataDir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\init-core-data-001
   [junit4]   2> INFO  - 2018-06-30 01:15:36.006; 
org.apache.solr.SolrTestCaseJ4; Using PointFields (NUMERIC_POINTS_SYSPROP=true) 
w/NUMERIC_DOCVALUES_SYSPROP=true
   [junit4]   2> INFO  - 2018-06-30 01:15:36.012; 
org.apache.solr.SolrTestCaseJ4; Randomized ssl (false) and clientAuth (false) 
via: @org.apache.solr.util.RandomizeSSL(reason=, value=NaN, ssl=NaN, 
clientAuth=NaN)
   [junit4]   2> INFO  - 2018-06-30 01:15:36.012; 
org.apache.solr.SolrTestCaseJ4; SecureRandom sanity checks: 
test.solr.allowed.securerandom=null & java.security.egd=file:/dev/./urandom
   [junit4]   2> INFO  - 2018-06-30 01:15:36.019; 
org.apache.solr.SolrTestCaseJ4; ###Starting testFullImportFqParam
   [junit4]   2> INFO  - 2018-06-30 01:15:36.054; 
org.apache.solr.SolrTestCaseJ4; ####initCore
   [junit4]   2> INFO  - 2018-06-30 01:15:36.336; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:36.529; 
org.apache.solr.schema.IndexSchema; [null] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:37.085; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:39.069; 
org.apache.solr.core.TransientSolrCoreCacheDefault; Allocating transient cache 
for 2147483647 transient cores
   [junit4]   2> INFO  - 2018-06-30 01:15:39.119; 
org.apache.solr.handler.admin.MetricsHistoryHandler; No .system collection, 
keeping metrics history in memory.
   [junit4]   2> INFO  - 2018-06-30 01:15:39.261; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.node' (registry 'solr.node') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:39.263; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jvm' (registry 'solr.jvm') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:39.263; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jetty' (registry 'solr.jetty') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:39.348; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:39.572; 
org.apache.solr.schema.IndexSchema; [collection1] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:39.588; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:39.594; 
org.apache.solr.core.CoreContainer; Creating SolrCore 'collection1' using 
configuration from instancedir 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-001\collection1,
 trusted=true
   [junit4]   2> INFO  - 2018-06-30 01:15:39.763; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:39.817; 
org.apache.solr.core.SolrCore; solr.RecoveryStrategy.Builder
   [junit4]   2> INFO  - 2018-06-30 01:15:39.828; 
org.apache.solr.core.SolrCore; [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-001\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\init-core-data-001\]
   [junit4]   2> INFO  - 2018-06-30 01:15:42.401; 
org.apache.solr.update.CommitTracker; Hard AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:42.401; 
org.apache.solr.update.CommitTracker; Soft AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:42.487; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@5dbf95e3[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:42.536; 
org.apache.solr.rest.ManagedResourceStorage; File-based storage initialized to 
use dir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-001\collection1\conf
   [junit4]   2> INFO  - 2018-06-30 01:15:42.653; 
org.apache.solr.handler.ReplicationHandler; Commits will be reserved for 
10000ms.
   [junit4]   2> INFO  - 2018-06-30 01:15:42.664; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@5dbf95e3[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> INFO  - 2018-06-30 01:15:42.666; 
org.apache.solr.SolrTestCaseJ4; ####initCore end
   [junit4]   2> INFO  - 2018-06-30 01:15:43.213; 
org.eclipse.jetty.server.Server; jetty-9.4.11.v20180605; built: 
2018-06-05T18:24:03.829Z; git: d5fc0523cfa96bfebfbda19606cad384d772f04c; jvm 
1.8.0_172-b11
   [junit4]   2> INFO  - 2018-06-30 01:15:43.256; 
org.eclipse.jetty.server.session; DefaultSessionIdManager workerName=node0
   [junit4]   2> INFO  - 2018-06-30 01:15:43.257; 
org.eclipse.jetty.server.session; No SessionScavenger set, using defaults
   [junit4]   2> INFO  - 2018-06-30 01:15:43.265; 
org.eclipse.jetty.server.session; node0 Scavenging every 600000ms
   [junit4]   2> INFO  - 2018-06-30 01:15:43.310; 
org.eclipse.jetty.server.handler.ContextHandler; Started 
o.e.j.s.ServletContextHandler@33545da9{/solr,null,AVAILABLE}
   [junit4]   2> INFO  - 2018-06-30 01:15:43.334; 
org.eclipse.jetty.server.AbstractConnector; Started 
ServerConnector@3f7287f4{HTTP/1.1,[http/1.1]}{127.0.0.1:59503}
   [junit4]   2> INFO  - 2018-06-30 01:15:43.334; 
org.eclipse.jetty.server.Server; Started @18154ms
   [junit4]   2> INFO  - 2018-06-30 01:15:43.334; 
org.apache.solr.client.solrj.embedded.JettySolrRunner; Jetty properties: 
{solr.data.dir=C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001\collection1\data,
 hostContext=/solr, hostPort=59503}
   [junit4]   2> INFO  - 2018-06-30 01:15:43.400; 
org.apache.solr.util.configuration.SSLCredentialProviderFactory; Processing SSL 
Credential Provider chain: env;sysprop
   [junit4]   2> ERROR - 2018-06-30 01:15:43.412; 
org.apache.solr.util.StartupLoggingUtils; Missing Java Option solr.log.dir. 
Logging may be missing or incomplete.
   [junit4]   2> INFO  - 2018-06-30 01:15:43.412; 
org.apache.solr.servlet.SolrDispatchFilter; Using logger factory 
org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> INFO  - 2018-06-30 01:15:43.412; 
org.apache.solr.servlet.SolrDispatchFilter;  ___      _       Welcome to Apache 
Solr™ version 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:43.412; 
org.apache.solr.servlet.SolrDispatchFilter; / __| ___| |_ _   Starting in 
standalone mode on port null
   [junit4]   2> INFO  - 2018-06-30 01:15:43.413; 
org.apache.solr.servlet.SolrDispatchFilter; \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> INFO  - 2018-06-30 01:15:43.414; 
org.apache.solr.servlet.SolrDispatchFilter; |___/\___/_|_|    Start time: 
2018-06-30T01:15:43.414Z
   [junit4]   2> INFO  - 2018-06-30 01:15:43.424; 
org.apache.solr.core.SolrXmlConfig; Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001\solr.xml
   [junit4]   2> INFO  - 2018-06-30 01:15:43.439; 
org.apache.solr.core.SolrXmlConfig; MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> INFO  - 2018-06-30 01:15:43.945; 
org.apache.solr.core.TransientSolrCoreCacheDefault; Allocating transient cache 
for 2147483647 transient cores
   [junit4]   2> INFO  - 2018-06-30 01:15:43.946; 
org.apache.solr.handler.admin.MetricsHistoryHandler; No .system collection, 
keeping metrics history in memory.
   [junit4]   2> INFO  - 2018-06-30 01:15:43.984; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.node' (registry 'solr.node') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:43.985; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jvm' (registry 'solr.jvm') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:43.985; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jetty' (registry 'solr.jetty') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:43.992; 
org.apache.solr.core.CorePropertiesLocator; Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001
   [junit4]   2> INFO  - 2018-06-30 01:15:43.992; 
org.apache.solr.core.CorePropertiesLocator; Cores are: [collection1]
   [junit4]   2> INFO  - 2018-06-30 01:15:44.035; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:44.073; 
org.apache.solr.schema.IndexSchema; [collection1] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:44.097; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:44.097; 
org.apache.solr.core.CoreContainer; Creating SolrCore 'collection1' using 
configuration from instancedir 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001\collection1,
 trusted=true
   [junit4]   2> INFO  - 2018-06-30 01:15:44.098; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:44.098; 
org.apache.solr.core.SolrCore; solr.RecoveryStrategy.Builder
   [junit4]   2> INFO  - 2018-06-30 01:15:44.099; 
org.apache.solr.core.SolrCore; [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001\collection1\data\]
   [junit4]   2> INFO  - 2018-06-30 01:15:44.236; 
org.apache.solr.update.CommitTracker; Hard AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:44.236; 
org.apache.solr.update.CommitTracker; Soft AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:44.371; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@b4249e8[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:44.371; 
org.apache.solr.rest.ManagedResourceStorage; File-based storage initialized to 
use dir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001\collection1\conf
   [junit4]   2> INFO  - 2018-06-30 01:15:44.372; 
org.apache.solr.handler.ReplicationHandler; Commits will be reserved for 
10000ms.
   [junit4]   2> INFO  - 2018-06-30 01:15:44.374; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@b4249e8[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> INFO  - 2018-06-30 01:15:45.065; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=*:*&qt=&start=0&rows=20&version=2.2} hits=0 status=0 QTime=185
   [junit4]   2> INFO  - 2018-06-30 01:15:46.237; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[1, 2, 3, 4, 5, 6, 
7, 8, 9, 10, ... (30 adds)]} 0 412
   [junit4]   2> INFO  - 2018-06-30 01:15:46.329; 
org.apache.solr.update.DirectUpdateHandler2; start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> INFO  - 2018-06-30 01:15:46.330; 
org.apache.solr.update.SolrIndexWriter; Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@2bb405d5 commitCommandVersion:0
   [junit4]   2> INFO  - 2018-06-30 01:15:47.010; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@25832e49[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:47.016; 
org.apache.solr.update.DirectUpdateHandler2; end_commit_flush
   [junit4]   2> INFO  - 2018-06-30 01:15:47.029; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@25832e49[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.5.0):C30)))}
   [junit4]   2> INFO  - 2018-06-30 01:15:47.037; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=/solr path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 708
   [junit4]   2> INFO  - 2018-06-30 01:15:47.051; 
org.apache.solr.handler.dataimport.config.DIHConfiguration; id is a required 
field in SolrSchema . But not found in DataConfig
   [junit4]   2> INFO  - 2018-06-30 01:15:47.051; 
org.apache.solr.handler.dataimport.DataImporter; Data Configuration loaded 
successfully
   [junit4]   2> INFO  - 2018-06-30 01:15:47.054; 
org.apache.solr.handler.dataimport.DataImporter; Starting Full Import
   [junit4]   2> WARN  - 2018-06-30 01:15:47.098; 
org.apache.solr.handler.dataimport.SimplePropertiesWriter; Unable to read: 
dataimport.properties
   [junit4]   2> INFO  - 2018-06-30 01:15:47.145; 
org.apache.solr.update.DirectUpdateHandler2; [collection1] REMOVING ALL 
DOCUMENTS FROM INDEX
   [junit4]   2> INFO  - 2018-06-30 01:15:47.154; 
org.apache.solr.handler.dataimport.SolrEntityProcessor; using 
BinaryResponseParser
   [junit4]   2> INFO  - 2018-06-30 01:15:47.367; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=/solr path=/select 
params={q=*:*&start=0&timeAllowed=300000&fq=desc:Description1*&fq=desc:Description*2&rows=2&wt=javabin&version=2}
 hits=1 status=0 QTime=200
   [junit4]   2> INFO  - 2018-06-30 01:15:47.390; 
org.apache.solr.handler.dataimport.DocBuilder; Import completed successfully
   [junit4]   2> INFO  - 2018-06-30 01:15:47.390; 
org.apache.solr.update.DirectUpdateHandler2; start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> INFO  - 2018-06-30 01:15:47.391; 
org.apache.solr.update.SolrIndexWriter; Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@5b5fc890 commitCommandVersion:0
   [junit4]   2> INFO  - 2018-06-30 01:15:47.628; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@14b81c3a[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:47.629; 
org.apache.solr.update.DirectUpdateHandler2; end_commit_flush
   [junit4]   2> INFO  - 2018-06-30 01:15:47.636; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@14b81c3a[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.5.0):C1)))}
   [junit4]   2> WARN  - 2018-06-30 01:15:47.637; 
org.apache.solr.handler.dataimport.SimplePropertiesWriter; Unable to read: 
dataimport.properties
   [junit4]   2> INFO  - 2018-06-30 01:15:47.638; 
org.apache.solr.handler.dataimport.SimplePropertiesWriter; Wrote last indexed 
time to dataimport.properties
   [junit4]   2> INFO  - 2018-06-30 01:15:47.638; 
org.apache.solr.handler.dataimport.DocBuilder; Time taken = 0:0:0.540
   [junit4]   2> INFO  - 2018-06-30 01:15:47.638; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=null path=null 
params={debug=on&commit=true&dataConfig=<dataConfig>%0d%0a++<document>%0d%0a++++<entity+name%3D'se'+processor%3D'SolrEntityProcessor'+++url%3D'http://127.0.0.1:59503/solr/collection1'+query%3D'*:*'+fq%3D'desc:Description1*,desc:Description*2'+rows%3D'2'+/>%0d%0a++</document>%0d%0a</dataConfig>%0d%0a&clean=true&rows=50&command=full-import}{deleteByQuery=*:*,add=[12],commit=}
 0 600
   [junit4]   2> INFO  - 2018-06-30 01:15:47.639; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=*:*&qt=&start=0&rows=20&version=2.2} hits=1 status=0 QTime=0
   [junit4]   2> INFO  - 2018-06-30 01:15:47.650; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=id:12&qt=&start=0&rows=20&version=2.2} hits=1 status=0 QTime=5
   [junit4]   2> INFO  - 2018-06-30 01:15:47.656; 
org.apache.solr.SolrTestCaseJ4; ###deleteCore
   [junit4]   2> INFO  - 2018-06-30 01:15:47.656; 
org.apache.solr.core.CoreContainer; Shutting down CoreContainer 
instance=441190374
   [junit4]   2> INFO  - 2018-06-30 01:15:47.657; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:47.658; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@47d9e2da: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@22258b4a
   [junit4]   2> INFO  - 2018-06-30 01:15:47.663; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:47.664; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@cb087d7: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@1c07a7d6
   [junit4]   2> INFO  - 2018-06-30 01:15:47.669; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:47.669; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@5d7c805b: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@3d0540a5
   [junit4]   2> INFO  - 2018-06-30 01:15:47.676; 
org.apache.solr.core.SolrCore; [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@46896121
   [junit4]   2> INFO  - 2018-06-30 01:15:47.677; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.core.collection1, tag=46896121
   [junit4]   2> INFO  - 2018-06-30 01:15:47.677; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@21fe5e28: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@191bb2f
   [junit4]   2> INFO  - 2018-06-30 01:15:47.715; 
org.eclipse.jetty.server.AbstractConnector; Stopped 
ServerConnector@3f7287f4{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> INFO  - 2018-06-30 01:15:47.715; 
org.apache.solr.core.CoreContainer; Shutting down CoreContainer 
instance=1368789224
   [junit4]   2> INFO  - 2018-06-30 01:15:47.716; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:47.716; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@43f625c5: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@b38b50a
   [junit4]   2> INFO  - 2018-06-30 01:15:47.727; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:47.727; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@61c83dad: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@1c07a7d6
   [junit4]   2> INFO  - 2018-06-30 01:15:47.733; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:47.733; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@312476db: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@3d0540a5
   [junit4]   2> INFO  - 2018-06-30 01:15:47.734; 
org.apache.solr.core.SolrCore; [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@133f542f
   [junit4]   2> INFO  - 2018-06-30 01:15:47.735; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.core.collection1, tag=133f542f
   [junit4]   2> INFO  - 2018-06-30 01:15:47.735; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@a6dda0d: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@49cfb640
   [junit4]   2> INFO  - 2018-06-30 01:15:47.756; 
org.eclipse.jetty.server.handler.ContextHandler; Stopped 
o.e.j.s.ServletContextHandler@33545da9{/solr,null,UNAVAILABLE}
   [junit4]   2> INFO  - 2018-06-30 01:15:47.757; 
org.eclipse.jetty.server.session; node0 Stopped scavenging
   [junit4]   2> INFO  - 2018-06-30 01:15:47.765; 
org.apache.solr.SolrTestCaseJ4; ###Ending testFullImportFqParam
   [junit4]   2> INFO  - 2018-06-30 01:15:47.771; 
org.apache.solr.SolrTestCaseJ4; ###Starting testCursorMarkNoSort
   [junit4]   2> INFO  - 2018-06-30 01:15:47.793; 
org.apache.solr.SolrTestCaseJ4; ####initCore
   [junit4]   2> INFO  - 2018-06-30 01:15:47.822; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:47.840; 
org.apache.solr.schema.IndexSchema; [null] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:47.853; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:48.001; 
org.apache.solr.core.TransientSolrCoreCacheDefault; Allocating transient cache 
for 2147483647 transient cores
   [junit4]   2> INFO  - 2018-06-30 01:15:48.001; 
org.apache.solr.handler.admin.MetricsHistoryHandler; No .system collection, 
keeping metrics history in memory.
   [junit4]   2> INFO  - 2018-06-30 01:15:48.029; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.node' (registry 'solr.node') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.036; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jvm' (registry 'solr.jvm') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.037; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jetty' (registry 'solr.jetty') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.066; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:48.080; 
org.apache.solr.schema.IndexSchema; [collection1] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:48.092; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:48.093; 
org.apache.solr.core.CoreContainer; Creating SolrCore 'collection1' using 
configuration from instancedir 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-002\collection1,
 trusted=true
   [junit4]   2> INFO  - 2018-06-30 01:15:48.093; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.093; 
org.apache.solr.core.SolrCore; solr.RecoveryStrategy.Builder
   [junit4]   2> INFO  - 2018-06-30 01:15:48.093; 
org.apache.solr.core.SolrCore; [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-002\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-001\collection1\data\]
   [junit4]   2> INFO  - 2018-06-30 01:15:48.460; 
org.apache.solr.update.CommitTracker; Hard AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:48.460; 
org.apache.solr.update.CommitTracker; Soft AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:48.471; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@390f79ab[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:48.472; 
org.apache.solr.rest.ManagedResourceStorage; File-based storage initialized to 
use dir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-002\collection1\conf
   [junit4]   2> INFO  - 2018-06-30 01:15:48.475; 
org.apache.solr.handler.ReplicationHandler; Commits will be reserved for 
10000ms.
   [junit4]   2> INFO  - 2018-06-30 01:15:48.478; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@390f79ab[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> INFO  - 2018-06-30 01:15:48.489; 
org.apache.solr.SolrTestCaseJ4; ####initCore end
   [junit4]   2> INFO  - 2018-06-30 01:15:48.509; 
org.eclipse.jetty.server.Server; jetty-9.4.11.v20180605; built: 
2018-06-05T18:24:03.829Z; git: d5fc0523cfa96bfebfbda19606cad384d772f04c; jvm 
1.8.0_172-b11
   [junit4]   2> INFO  - 2018-06-30 01:15:48.511; 
org.eclipse.jetty.server.session; DefaultSessionIdManager workerName=node0
   [junit4]   2> INFO  - 2018-06-30 01:15:48.511; 
org.eclipse.jetty.server.session; No SessionScavenger set, using defaults
   [junit4]   2> INFO  - 2018-06-30 01:15:48.511; 
org.eclipse.jetty.server.session; node0 Scavenging every 600000ms
   [junit4]   2> INFO  - 2018-06-30 01:15:48.513; 
org.eclipse.jetty.server.handler.ContextHandler; Started 
o.e.j.s.ServletContextHandler@d6652ee{/solr,null,AVAILABLE}
   [junit4]   2> INFO  - 2018-06-30 01:15:48.514; 
org.eclipse.jetty.server.AbstractConnector; Started 
ServerConnector@7a01136a{HTTP/1.1,[http/1.1]}{127.0.0.1:59508}
   [junit4]   2> INFO  - 2018-06-30 01:15:48.514; 
org.eclipse.jetty.server.Server; Started @23334ms
   [junit4]   2> INFO  - 2018-06-30 01:15:48.514; 
org.apache.solr.client.solrj.embedded.JettySolrRunner; Jetty properties: 
{solr.data.dir=C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002\collection1\data,
 hostContext=/solr, hostPort=59508}
   [junit4]   2> ERROR - 2018-06-30 01:15:48.514; 
org.apache.solr.util.StartupLoggingUtils; Missing Java Option solr.log.dir. 
Logging may be missing or incomplete.
   [junit4]   2> INFO  - 2018-06-30 01:15:48.514; 
org.apache.solr.servlet.SolrDispatchFilter; Using logger factory 
org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> INFO  - 2018-06-30 01:15:48.515; 
org.apache.solr.servlet.SolrDispatchFilter;  ___      _       Welcome to Apache 
Solr™ version 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:48.515; 
org.apache.solr.servlet.SolrDispatchFilter; / __| ___| |_ _   Starting in 
standalone mode on port null
   [junit4]   2> INFO  - 2018-06-30 01:15:48.515; 
org.apache.solr.servlet.SolrDispatchFilter; \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> INFO  - 2018-06-30 01:15:48.515; 
org.apache.solr.servlet.SolrDispatchFilter; |___/\___/_|_|    Start time: 
2018-06-30T01:15:48.515Z
   [junit4]   2> INFO  - 2018-06-30 01:15:48.515; 
org.apache.solr.core.SolrXmlConfig; Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002\solr.xml
   [junit4]   2> INFO  - 2018-06-30 01:15:48.530; 
org.apache.solr.core.SolrXmlConfig; MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> INFO  - 2018-06-30 01:15:48.664; 
org.apache.solr.core.TransientSolrCoreCacheDefault; Allocating transient cache 
for 2147483647 transient cores
   [junit4]   2> INFO  - 2018-06-30 01:15:48.664; 
org.apache.solr.handler.admin.MetricsHistoryHandler; No .system collection, 
keeping metrics history in memory.
   [junit4]   2> INFO  - 2018-06-30 01:15:48.700; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.node' (registry 'solr.node') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.708; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jvm' (registry 'solr.jvm') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.709; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jetty' (registry 'solr.jetty') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.733; 
org.apache.solr.core.CorePropertiesLocator; Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002
   [junit4]   2> INFO  - 2018-06-30 01:15:48.733; 
org.apache.solr.core.CorePropertiesLocator; Cores are: [collection1]
   [junit4]   2> INFO  - 2018-06-30 01:15:48.798; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:48.820; 
org.apache.solr.schema.IndexSchema; [collection1] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:48.834; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:48.834; 
org.apache.solr.core.CoreContainer; Creating SolrCore 'collection1' using 
configuration from instancedir 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002\collection1,
 trusted=true
   [junit4]   2> INFO  - 2018-06-30 01:15:48.835; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:48.835; 
org.apache.solr.core.SolrCore; solr.RecoveryStrategy.Builder
   [junit4]   2> INFO  - 2018-06-30 01:15:48.835; 
org.apache.solr.core.SolrCore; [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002\collection1\data\]
   [junit4]   2> INFO  - 2018-06-30 01:15:48.991; 
org.apache.solr.update.CommitTracker; Hard AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:48.991; 
org.apache.solr.update.CommitTracker; Soft AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:48.994; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@13854278[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:48.995; 
org.apache.solr.rest.ManagedResourceStorage; File-based storage initialized to 
use dir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002\collection1\conf
   [junit4]   2> INFO  - 2018-06-30 01:15:48.996; 
org.apache.solr.handler.ReplicationHandler; Commits will be reserved for 
10000ms.
   [junit4]   2> INFO  - 2018-06-30 01:15:48.999; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=*:*&qt=&start=0&rows=20&version=2.2} hits=0 status=0 QTime=0
   [junit4]   2> INFO  - 2018-06-30 01:15:48.999; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@13854278[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> INFO  - 2018-06-30 01:15:49.010; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[1, 2, 3, 4, 5, 6, 
7]} 0 4
   [junit4]   2> INFO  - 2018-06-30 01:15:49.012; 
org.apache.solr.update.DirectUpdateHandler2; start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> INFO  - 2018-06-30 01:15:49.012; 
org.apache.solr.update.SolrIndexWriter; Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@7842750b commitCommandVersion:0
   [junit4]   2> INFO  - 2018-06-30 01:15:49.073; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@5a7599ad[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:49.073; 
org.apache.solr.update.DirectUpdateHandler2; end_commit_flush
   [junit4]   2> INFO  - 2018-06-30 01:15:49.075; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@5a7599ad[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.5.0):C7)))}
   [junit4]   2> INFO  - 2018-06-30 01:15:49.075; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=/solr path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 63
   [junit4]   2> INFO  - 2018-06-30 01:15:49.081; 
org.apache.solr.handler.dataimport.config.DIHConfiguration; id is a required 
field in SolrSchema . But not found in DataConfig
   [junit4]   2> INFO  - 2018-06-30 01:15:49.082; 
org.apache.solr.handler.dataimport.DataImporter; Data Configuration loaded 
successfully
   [junit4]   2> INFO  - 2018-06-30 01:15:49.082; 
org.apache.solr.handler.dataimport.DataImporter; Starting Full Import
   [junit4]   2> WARN  - 2018-06-30 01:15:49.082; 
org.apache.solr.handler.dataimport.SimplePropertiesWriter; Unable to read: 
dataimport.properties
   [junit4]   2> INFO  - 2018-06-30 01:15:49.083; 
org.apache.solr.update.DirectUpdateHandler2; [collection1] REMOVING ALL 
DOCUMENTS FROM INDEX
   [junit4]   2> INFO  - 2018-06-30 01:15:49.085; 
org.apache.solr.handler.dataimport.SolrEntityProcessor; using 
BinaryResponseParser
   [junit4]   2> ERROR - 2018-06-30 01:15:49.095; 
org.apache.solr.handler.RequestHandlerBase; 
org.apache.solr.common.SolrException: Cursor functionality requires a sort 
containing a uniqueKey field tie breaker
   [junit4]   2>        at 
org.apache.solr.search.CursorMark.<init>(CursorMark.java:82)
   [junit4]   2>        at 
org.apache.solr.handler.component.QueryComponent.prepare(QueryComponent.java:193)
   [junit4]   2>        at 
org.apache.solr.handler.component.SearchHandler.handleRequestBody(SearchHandler.java:272)
   [junit4]   2>        at 
org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:199)
   [junit4]   2>        at 
org.apache.solr.core.SolrCore.execute(SolrCore.java:2539)
   [junit4]   2>        at 
org.apache.solr.servlet.HttpSolrCall.execute(HttpSolrCall.java:709)
   [junit4]   2>        at 
org.apache.solr.servlet.HttpSolrCall.call(HttpSolrCall.java:515)
   [junit4]   2>        at 
org.apache.solr.servlet.SolrDispatchFilter.doFilter(SolrDispatchFilter.java:377)
   [junit4]   2>        at 
org.apache.solr.servlet.SolrDispatchFilter.doFilter(SolrDispatchFilter.java:323)
   [junit4]   2>        at 
org.eclipse.jetty.servlet.ServletHandler$CachedChain.doFilter(ServletHandler.java:1642)
   [junit4]   2>        at 
org.apache.solr.client.solrj.embedded.JettySolrRunner$DebugFilter.doFilter(JettySolrRunner.java:139)
   [junit4]   2>        at 
org.eclipse.jetty.servlet.ServletHandler$CachedChain.doFilter(ServletHandler.java:1642)
   [junit4]   2>        at 
org.eclipse.jetty.servlet.ServletHandler.doHandle(ServletHandler.java:533)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:255)
   [junit4]   2>        at 
org.eclipse.jetty.server.session.SessionHandler.doHandle(SessionHandler.java:1595)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.ScopedHandler.nextHandle(ScopedHandler.java:255)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.ContextHandler.doHandle(ContextHandler.java:1317)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.ScopedHandler.nextScope(ScopedHandler.java:203)
   [junit4]   2>        at 
org.eclipse.jetty.servlet.ServletHandler.doScope(ServletHandler.java:473)
   [junit4]   2>        at 
org.eclipse.jetty.server.session.SessionHandler.doScope(SessionHandler.java:1564)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.ScopedHandler.nextScope(ScopedHandler.java:201)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.ContextHandler.doScope(ContextHandler.java:1219)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.ScopedHandler.handle(ScopedHandler.java:144)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.gzip.GzipHandler.handle(GzipHandler.java:724)
   [junit4]   2>        at 
org.eclipse.jetty.server.handler.HandlerWrapper.handle(HandlerWrapper.java:132)
   [junit4]   2>        at 
org.eclipse.jetty.server.Server.handle(Server.java:531)
   [junit4]   2>        at 
org.eclipse.jetty.server.HttpChannel.handle(HttpChannel.java:352)
   [junit4]   2>        at 
org.eclipse.jetty.server.HttpConnection.onFillable(HttpConnection.java:260)
   [junit4]   2>        at 
org.eclipse.jetty.io.AbstractConnection$ReadCallback.succeeded(AbstractConnection.java:281)
   [junit4]   2>        at 
org.eclipse.jetty.io.FillInterest.fillable(FillInterest.java:102)
   [junit4]   2>        at 
org.eclipse.jetty.io.ChannelEndPoint$2.run(ChannelEndPoint.java:118)
   [junit4]   2>        at 
org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.runTask(EatWhatYouKill.java:333)
   [junit4]   2>        at 
org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.doProduce(EatWhatYouKill.java:310)
   [junit4]   2>        at 
org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.tryProduce(EatWhatYouKill.java:168)
   [junit4]   2>        at 
org.eclipse.jetty.util.thread.strategy.EatWhatYouKill.run(EatWhatYouKill.java:126)
   [junit4]   2>        at 
org.eclipse.jetty.util.thread.ReservedThreadExecutor$ReservedThread.run(ReservedThreadExecutor.java:366)
   [junit4]   2>        at 
org.eclipse.jetty.util.thread.QueuedThreadPool.runJob(QueuedThreadPool.java:762)
   [junit4]   2>        at 
org.eclipse.jetty.util.thread.QueuedThreadPool$2.run(QueuedThreadPool.java:680)
   [junit4]   2>        at java.lang.Thread.run(Thread.java:748)
   [junit4]   2> 
   [junit4]   2> INFO  - 2018-06-30 01:15:49.097; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=/solr path=/select 
params={q=*:*&fl=id,desc&cursorMark=*&rows=2&wt=javabin&version=2} status=400 
QTime=6
   [junit4]   2> ERROR - 2018-06-30 01:15:49.105; 
org.apache.solr.handler.dataimport.DocBuilder; Exception while processing: se 
document : SolrInputDocument(fields: 
[]):org.apache.solr.handler.dataimport.DataImportHandlerException: 
org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error 
from server at http://127.0.0.1:59508/solr/collection1: Cursor functionality 
requires a sort containing a uniqueKey field tie breaker
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImportHandlerException.wrapAndThrow(DataImportHandlerException.java:61)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor$SolrDocumentListIterator.doQuery(SolrEntityProcessor.java:258)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor.nextPage(SolrEntityProcessor.java:160)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor.buildIterator(SolrEntityProcessor.java:155)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor.nextRow(SolrEntityProcessor.java:136)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.EntityProcessorWrapper.nextRow(EntityProcessorWrapper.java:267)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.buildDocument(DocBuilder.java:476)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.buildDocument(DocBuilder.java:415)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.doFullDump(DocBuilder.java:330)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.execute(DocBuilder.java:233)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImporter.doFullImport(DataImporter.java:424)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImporter.runCmd(DataImporter.java:483)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImportHandler.handleRequestBody(DataImportHandler.java:184)
   [junit4]   2>        at 
org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:199)
   [junit4]   2>        at 
org.apache.solr.core.SolrCore.execute(SolrCore.java:2539)
   [junit4]   2>        at 
org.apache.solr.util.TestHarness.query(TestHarness.java:337)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.AbstractDataImportHandlerTestCase.runFullImport(AbstractDataImportHandlerTestCase.java:87)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd.testCursorMarkNoSort(TestSolrEntityProcessorEndToEnd.java:277)
   [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:498)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
   [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:49)
   [junit4]   2>        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:943)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
   [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:45)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
   [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:53)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
   [junit4]   2>        at java.lang.Thread.run(Thread.java:748)
   [junit4]   2> Caused by: 
org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error 
from server at http://127.0.0.1:59508/solr/collection1: Cursor functionality 
requires a sort containing a uniqueKey field tie breaker
   [junit4]   2>        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:643)
   [junit4]   2>        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:255)
   [junit4]   2>        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:244)
   [junit4]   2>        at 
org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:194)
   [junit4]   2>        at 
org.apache.solr.client.solrj.SolrClient.query(SolrClient.java:942)
   [junit4]   2>        at 
org.apache.solr.client.solrj.SolrClient.query(SolrClient.java:957)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor$SolrDocumentListIterator.doQuery(SolrEntityProcessor.java:255)
   [junit4]   2>        ... 55 more
   [junit4]   2> 
   [junit4]   2> INFO  - 2018-06-30 01:15:49.106; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=null path=null 
params={debug=on&commit=true&dataConfig=<dataConfig>%0d%0a++<document>%0d%0a++++<entity+name%3D'se'+processor%3D'SolrEntityProcessor'+++url%3D'http://127.0.0.1:59508/solr/collection1'+query%3D'*:*'+rows%3D'2'+fl%3D'id,desc'+cursorMark%3D'true'++/>%0d%0a++</document>%0d%0a</dataConfig>%0d%0a&clean=true&wt=xml&command=full-import}{deleteByQuery=*:*}
 0 27
   [junit4]   2> ERROR - 2018-06-30 01:15:49.106; 
org.apache.solr.handler.dataimport.DataImporter; Full Import 
failed:java.lang.RuntimeException: java.lang.RuntimeException: 
org.apache.solr.handler.dataimport.DataImportHandlerException: 
org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error 
from server at http://127.0.0.1:59508/solr/collection1: Cursor functionality 
requires a sort containing a uniqueKey field tie breaker
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.execute(DocBuilder.java:271)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImporter.doFullImport(DataImporter.java:424)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImporter.runCmd(DataImporter.java:483)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImportHandler.handleRequestBody(DataImportHandler.java:184)
   [junit4]   2>        at 
org.apache.solr.handler.RequestHandlerBase.handleRequest(RequestHandlerBase.java:199)
   [junit4]   2>        at 
org.apache.solr.core.SolrCore.execute(SolrCore.java:2539)
   [junit4]   2>        at 
org.apache.solr.util.TestHarness.query(TestHarness.java:337)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.AbstractDataImportHandlerTestCase.runFullImport(AbstractDataImportHandlerTestCase.java:87)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd.testCursorMarkNoSort(TestSolrEntityProcessorEndToEnd.java:277)
   [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:498)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.invoke(RandomizedRunner.java:1737)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$8.evaluate(RandomizedRunner.java:934)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$9.evaluate(RandomizedRunner.java:970)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$10.evaluate(RandomizedRunner.java:984)
   [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:49)
   [junit4]   2>        at 
org.apache.lucene.util.AbstractBeforeAfterRule$1.evaluate(AbstractBeforeAfterRule.java:45)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleThreadAndTestName$1.evaluate(TestRuleThreadAndTestName.java:48)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl.forkTimeoutingTask(ThreadLeakControl.java:817)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$3.evaluate(ThreadLeakControl.java:468)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner.runSingleTest(RandomizedRunner.java:943)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$5.evaluate(RandomizedRunner.java:829)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$6.evaluate(RandomizedRunner.java:879)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.RandomizedRunner$7.evaluate(RandomizedRunner.java:890)
   [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:45)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleStoreClassName$1.evaluate(TestRuleStoreClassName.java:41)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.NoShadowingOrOverridesOnMethodsRule$1.evaluate(NoShadowingOrOverridesOnMethodsRule.java:40)
   [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:53)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleMarkFailure$1.evaluate(TestRuleMarkFailure.java:47)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreAfterMaxFailures$1.evaluate(TestRuleIgnoreAfterMaxFailures.java:64)
   [junit4]   2>        at 
org.apache.lucene.util.TestRuleIgnoreTestSuites$1.evaluate(TestRuleIgnoreTestSuites.java:54)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.rules.StatementAdapter.evaluate(StatementAdapter.java:36)
   [junit4]   2>        at 
com.carrotsearch.randomizedtesting.ThreadLeakControl$StatementRunner.run(ThreadLeakControl.java:368)
   [junit4]   2>        at java.lang.Thread.run(Thread.java:748)
   [junit4]   2> Caused by: java.lang.RuntimeException: 
org.apache.solr.handler.dataimport.DataImportHandlerException: 
org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error 
from server at http://127.0.0.1:59508/solr/collection1: Cursor functionality 
requires a sort containing a uniqueKey field tie breaker
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.buildDocument(DocBuilder.java:417)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.doFullDump(DocBuilder.java:330)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.execute(DocBuilder.java:233)
   [junit4]   2>        ... 47 more
   [junit4]   2> Caused by: 
org.apache.solr.handler.dataimport.DataImportHandlerException: 
org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error 
from server at http://127.0.0.1:59508/solr/collection1: Cursor functionality 
requires a sort containing a uniqueKey field tie breaker
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DataImportHandlerException.wrapAndThrow(DataImportHandlerException.java:61)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor$SolrDocumentListIterator.doQuery(SolrEntityProcessor.java:258)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor.nextPage(SolrEntityProcessor.java:160)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor.buildIterator(SolrEntityProcessor.java:155)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor.nextRow(SolrEntityProcessor.java:136)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.EntityProcessorWrapper.nextRow(EntityProcessorWrapper.java:267)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.buildDocument(DocBuilder.java:476)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.DocBuilder.buildDocument(DocBuilder.java:415)
   [junit4]   2>        ... 49 more
   [junit4]   2> Caused by: 
org.apache.solr.client.solrj.impl.HttpSolrClient$RemoteSolrException: Error 
from server at http://127.0.0.1:59508/solr/collection1: Cursor functionality 
requires a sort containing a uniqueKey field tie breaker
   [junit4]   2>        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.executeMethod(HttpSolrClient.java:643)
   [junit4]   2>        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:255)
   [junit4]   2>        at 
org.apache.solr.client.solrj.impl.HttpSolrClient.request(HttpSolrClient.java:244)
   [junit4]   2>        at 
org.apache.solr.client.solrj.SolrRequest.process(SolrRequest.java:194)
   [junit4]   2>        at 
org.apache.solr.client.solrj.SolrClient.query(SolrClient.java:942)
   [junit4]   2>        at 
org.apache.solr.client.solrj.SolrClient.query(SolrClient.java:957)
   [junit4]   2>        at 
org.apache.solr.handler.dataimport.SolrEntityProcessor$SolrDocumentListIterator.doQuery(SolrEntityProcessor.java:255)
   [junit4]   2>        ... 55 more
   [junit4]   2> 
   [junit4]   2> INFO  - 2018-06-30 01:15:49.113; 
org.apache.solr.update.DirectUpdateHandler2; start rollback{}
   [junit4]   2> INFO  - 2018-06-30 01:15:49.117; 
org.apache.solr.update.DefaultSolrCoreState; New IndexWriter is ready to be 
used.
   [junit4]   2> INFO  - 2018-06-30 01:15:49.117; 
org.apache.solr.update.DirectUpdateHandler2; end_rollback
   [junit4]   2> INFO  - 2018-06-30 01:15:49.119; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=*:*&qt=&start=0&rows=20&version=2.2} hits=0 status=0 QTime=0
   [junit4]   2> INFO  - 2018-06-30 01:15:49.120; 
org.apache.solr.SolrTestCaseJ4; ###deleteCore
   [junit4]   2> INFO  - 2018-06-30 01:15:49.120; 
org.apache.solr.core.CoreContainer; Shutting down CoreContainer 
instance=1229640240
   [junit4]   2> INFO  - 2018-06-30 01:15:49.120; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:49.120; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@270d9a78: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@3e0f101f
   [junit4]   2> INFO  - 2018-06-30 01:15:49.122; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:49.123; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@99ff5a4: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@1c07a7d6
   [junit4]   2> INFO  - 2018-06-30 01:15:49.125; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:49.125; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@47e9878f: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@3d0540a5
   [junit4]   2> INFO  - 2018-06-30 01:15:49.128; 
org.apache.solr.core.SolrCore; [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@1d9ea01a
   [junit4]   2> INFO  - 2018-06-30 01:15:49.128; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.core.collection1, tag=1d9ea01a
   [junit4]   2> INFO  - 2018-06-30 01:15:49.131; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@5c35ce0: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@534dc543
   [junit4]   2> INFO  - 2018-06-30 01:15:49.141; 
org.eclipse.jetty.server.AbstractConnector; Stopped 
ServerConnector@7a01136a{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> INFO  - 2018-06-30 01:15:49.142; 
org.apache.solr.core.CoreContainer; Shutting down CoreContainer 
instance=1553941615
   [junit4]   2> INFO  - 2018-06-30 01:15:49.142; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:49.143; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@484e5619: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@2c656c4a
   [junit4]   2> INFO  - 2018-06-30 01:15:49.147; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:49.147; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@46daf56d: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@1c07a7d6
   [junit4]   2> INFO  - 2018-06-30 01:15:49.150; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:49.150; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@4af7f897: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@3d0540a5
   [junit4]   2> INFO  - 2018-06-30 01:15:49.167; 
org.apache.solr.core.SolrCore; [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@346987f5
   [junit4]   2> INFO  - 2018-06-30 01:15:49.168; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.core.collection1, tag=346987f5
   [junit4]   2> INFO  - 2018-06-30 01:15:49.168; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@446bdb08: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@167be285
   [junit4]   2> INFO  - 2018-06-30 01:15:49.183; 
org.eclipse.jetty.server.handler.ContextHandler; Stopped 
o.e.j.s.ServletContextHandler@d6652ee{/solr,null,UNAVAILABLE}
   [junit4]   2> INFO  - 2018-06-30 01:15:49.183; 
org.eclipse.jetty.server.session; node0 Stopped scavenging
   [junit4]   2> INFO  - 2018-06-30 01:15:49.192; 
org.apache.solr.SolrTestCaseJ4; ###Ending testCursorMarkNoSort
   [junit4]   2> INFO  - 2018-06-30 01:15:49.194; 
org.apache.solr.SolrTestCaseJ4; ###Starting testFullImportInnerEntity
   [junit4]   2> INFO  - 2018-06-30 01:15:49.218; 
org.apache.solr.SolrTestCaseJ4; ####initCore
   [junit4]   2> INFO  - 2018-06-30 01:15:49.253; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:49.271; 
org.apache.solr.schema.IndexSchema; [null] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:49.286; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:49.696; 
org.apache.solr.core.TransientSolrCoreCacheDefault; Allocating transient cache 
for 2147483647 transient cores
   [junit4]   2> INFO  - 2018-06-30 01:15:49.696; 
org.apache.solr.handler.admin.MetricsHistoryHandler; No .system collection, 
keeping metrics history in memory.
   [junit4]   2> INFO  - 2018-06-30 01:15:49.733; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.node' (registry 'solr.node') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:49.738; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jvm' (registry 'solr.jvm') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:49.739; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jetty' (registry 'solr.jetty') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:49.785; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:49.799; 
org.apache.solr.schema.IndexSchema; [collection1] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:49.812; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:49.813; 
org.apache.solr.core.CoreContainer; Creating SolrCore 'collection1' using 
configuration from instancedir 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-003\collection1,
 trusted=true
   [junit4]   2> INFO  - 2018-06-30 01:15:49.814; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:49.815; 
org.apache.solr.core.SolrCore; solr.RecoveryStrategy.Builder
   [junit4]   2> INFO  - 2018-06-30 01:15:49.815; 
org.apache.solr.core.SolrCore; [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-003\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-002\collection1\data\]
   [junit4]   2> INFO  - 2018-06-30 01:15:49.980; 
org.apache.solr.update.CommitTracker; Hard AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:49.980; 
org.apache.solr.update.CommitTracker; Soft AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:49.983; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@31e492b1[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:49.984; 
org.apache.solr.rest.ManagedResourceStorage; File-based storage initialized to 
use dir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\core-home-003\collection1\conf
   [junit4]   2> INFO  - 2018-06-30 01:15:49.984; 
org.apache.solr.handler.ReplicationHandler; Commits will be reserved for 
10000ms.
   [junit4]   2> INFO  - 2018-06-30 01:15:49.985; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@31e492b1[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> INFO  - 2018-06-30 01:15:49.989; 
org.apache.solr.SolrTestCaseJ4; ####initCore end
   [junit4]   2> INFO  - 2018-06-30 01:15:50.000; 
org.eclipse.jetty.server.Server; jetty-9.4.11.v20180605; built: 
2018-06-05T18:24:03.829Z; git: d5fc0523cfa96bfebfbda19606cad384d772f04c; jvm 
1.8.0_172-b11
   [junit4]   2> INFO  - 2018-06-30 01:15:50.001; 
org.eclipse.jetty.server.session; DefaultSessionIdManager workerName=node0
   [junit4]   2> INFO  - 2018-06-30 01:15:50.001; 
org.eclipse.jetty.server.session; No SessionScavenger set, using defaults
   [junit4]   2> INFO  - 2018-06-30 01:15:50.001; 
org.eclipse.jetty.server.session; node0 Scavenging every 600000ms
   [junit4]   2> INFO  - 2018-06-30 01:15:50.001; 
org.eclipse.jetty.server.handler.ContextHandler; Started 
o.e.j.s.ServletContextHandler@4a11b6a7{/solr,null,AVAILABLE}
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.eclipse.jetty.server.AbstractConnector; Started 
ServerConnector@5d0697f1{HTTP/1.1,[http/1.1]}{127.0.0.1:59513}
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.eclipse.jetty.server.Server; Started @24823ms
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.apache.solr.client.solrj.embedded.JettySolrRunner; Jetty properties: 
{solr.data.dir=C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-003\collection1\data,
 hostContext=/solr, hostPort=59513}
   [junit4]   2> ERROR - 2018-06-30 01:15:50.003; 
org.apache.solr.util.StartupLoggingUtils; Missing Java Option solr.log.dir. 
Logging may be missing or incomplete.
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.apache.solr.servlet.SolrDispatchFilter; Using logger factory 
org.apache.logging.slf4j.Log4jLoggerFactory
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.apache.solr.servlet.SolrDispatchFilter;  ___      _       Welcome to Apache 
Solr™ version 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.apache.solr.servlet.SolrDispatchFilter; / __| ___| |_ _   Starting in 
standalone mode on port null
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.apache.solr.servlet.SolrDispatchFilter; \__ \/ _ \ | '_|  Install dir: null
   [junit4]   2> INFO  - 2018-06-30 01:15:50.003; 
org.apache.solr.servlet.SolrDispatchFilter; |___/\___/_|_|    Start time: 
2018-06-30T01:15:50.003Z
   [junit4]   2> INFO  - 2018-06-30 01:15:50.004; 
org.apache.solr.core.SolrXmlConfig; Loading container configuration from 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-003\solr.xml
   [junit4]   2> INFO  - 2018-06-30 01:15:50.011; 
org.apache.solr.core.SolrXmlConfig; MBean server found: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe, but no JMX reporters were 
configured - adding default JMX reporter.
   [junit4]   2> INFO  - 2018-06-30 01:15:50.387; 
org.apache.solr.core.TransientSolrCoreCacheDefault; Allocating transient cache 
for 2147483647 transient cores
   [junit4]   2> INFO  - 2018-06-30 01:15:50.387; 
org.apache.solr.handler.admin.MetricsHistoryHandler; No .system collection, 
keeping metrics history in memory.
   [junit4]   2> INFO  - 2018-06-30 01:15:50.410; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.node' (registry 'solr.node') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:50.416; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jvm' (registry 'solr.jvm') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:50.416; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.jetty' (registry 'solr.jetty') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:50.422; 
org.apache.solr.core.CorePropertiesLocator; Found 1 core definitions underneath 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-003
   [junit4]   2> INFO  - 2018-06-30 01:15:50.422; 
org.apache.solr.core.CorePropertiesLocator; Cores are: [collection1]
   [junit4]   2> INFO  - 2018-06-30 01:15:50.476; 
org.apache.solr.core.SolrConfig; Using Lucene MatchVersion: 7.5.0
   [junit4]   2> INFO  - 2018-06-30 01:15:50.491; 
org.apache.solr.schema.IndexSchema; [collection1] Schema name=dih_test
   [junit4]   2> INFO  - 2018-06-30 01:15:50.502; 
org.apache.solr.schema.IndexSchema; Loaded schema dih_test/4.0 with uniqueid 
field id
   [junit4]   2> INFO  - 2018-06-30 01:15:50.502; 
org.apache.solr.core.CoreContainer; Creating SolrCore 'collection1' using 
configuration from instancedir 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-003\collection1,
 trusted=true
   [junit4]   2> INFO  - 2018-06-30 01:15:50.504; 
org.apache.solr.metrics.reporters.SolrJmxReporter; JMX monitoring for 
'solr.core.collection1' (registry 'solr.core.collection1') enabled at server: 
com.sun.jmx.mbeanserver.JmxMBeanServer@5639fbbe
   [junit4]   2> INFO  - 2018-06-30 01:15:50.504; 
org.apache.solr.core.SolrCore; solr.RecoveryStrategy.Builder
   [junit4]   2> INFO  - 2018-06-30 01:15:50.504; 
org.apache.solr.core.SolrCore; [[collection1] ] Opening new SolrCore at 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-003\collection1],
 
dataDir=[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-003\collection1\data\]
   [junit4]   2> INFO  - 2018-06-30 01:15:50.665; 
org.apache.solr.update.CommitTracker; Hard AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:50.665; 
org.apache.solr.update.CommitTracker; Soft AutoCommit: disabled
   [junit4]   2> INFO  - 2018-06-30 01:15:50.683; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@4dc79d10[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:50.683; 
org.apache.solr.rest.ManagedResourceStorage; File-based storage initialized to 
use dir: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp\solr.handler.dataimport.TestSolrEntityProcessorEndToEnd_E17AE71AE5517447-001\tempDir-003\collection1\conf
   [junit4]   2> INFO  - 2018-06-30 01:15:50.684; 
org.apache.solr.handler.ReplicationHandler; Commits will be reserved for 
10000ms.
   [junit4]   2> INFO  - 2018-06-30 01:15:50.686; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@4dc79d10[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader())}
   [junit4]   2> INFO  - 2018-06-30 01:15:51.192; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=*:*&qt=&start=0&rows=20&version=2.2} hits=0 status=0 QTime=0
   [junit4]   2> INFO  - 2018-06-30 01:15:51.231; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=/solr path=/update params={wt=javabin&version=2}{add=[1, 2]} 0 26
   [junit4]   2> INFO  - 2018-06-30 01:15:51.233; 
org.apache.solr.update.DirectUpdateHandler2; start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> INFO  - 2018-06-30 01:15:51.234; 
org.apache.solr.update.SolrIndexWriter; Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@7d9da8d4 commitCommandVersion:0
   [junit4]   2> INFO  - 2018-06-30 01:15:51.305; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@58c1e59e[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:51.306; 
org.apache.solr.update.DirectUpdateHandler2; end_commit_flush
   [junit4]   2> INFO  - 2018-06-30 01:15:51.308; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@58c1e59e[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.5.0):C2)))}
   [junit4]   2> INFO  - 2018-06-30 01:15:51.308; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=/solr path=/update 
params={waitSearcher=true&commit=true&softCommit=false&wt=javabin&version=2}{commit=}
 0 74
   [junit4]   2> INFO  - 2018-06-30 01:15:51.312; 
org.apache.solr.handler.dataimport.DataImporter; Data Configuration loaded 
successfully
   [junit4]   2> INFO  - 2018-06-30 01:15:51.312; 
org.apache.solr.handler.dataimport.DataImporter; Starting Full Import
   [junit4]   2> WARN  - 2018-06-30 01:15:51.313; 
org.apache.solr.handler.dataimport.SimplePropertiesWriter; Unable to read: 
dataimport.properties
   [junit4]   2> INFO  - 2018-06-30 01:15:51.314; 
org.apache.solr.update.DirectUpdateHandler2; [collection1] REMOVING ALL 
DOCUMENTS FROM INDEX
   [junit4]   2> INFO  - 2018-06-30 01:15:51.359; 
org.apache.solr.handler.dataimport.SolrEntityProcessor; using 
BinaryResponseParser
   [junit4]   2> INFO  - 2018-06-30 01:15:51.362; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=/solr path=/select 
params={q=id:1&start=0&timeAllowed=300000&rows=50&wt=javabin&version=2} hits=1 
status=0 QTime=1
   [junit4]   2> INFO  - 2018-06-30 01:15:51.369; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=/solr path=/select 
params={q=id:2&start=0&timeAllowed=300000&rows=50&wt=javabin&version=2} hits=1 
status=0 QTime=1
   [junit4]   2> INFO  - 2018-06-30 01:15:51.370; 
org.apache.solr.handler.dataimport.DocBuilder; Import completed successfully
   [junit4]   2> INFO  - 2018-06-30 01:15:51.370; 
org.apache.solr.update.DirectUpdateHandler2; start 
commit{,optimize=false,openSearcher=true,waitSearcher=true,expungeDeletes=false,softCommit=false,prepareCommit=false}
   [junit4]   2> INFO  - 2018-06-30 01:15:51.370; 
org.apache.solr.update.SolrIndexWriter; Calling setCommitData with 
IW:org.apache.solr.update.SolrIndexWriter@31405548 commitCommandVersion:0
   [junit4]   2> INFO  - 2018-06-30 01:15:51.431; 
org.apache.solr.search.SolrIndexSearcher; Opening 
[Searcher@3a2d6893[collection1] main]
   [junit4]   2> INFO  - 2018-06-30 01:15:51.435; 
org.apache.solr.core.SolrCore; [collection1] Registered new searcher 
Searcher@3a2d6893[collection1] 
main{ExitableDirectoryReader(UninvertingDirectoryReader(Uninverting(_0(7.5.0):C2)))}
   [junit4]   2> INFO  - 2018-06-30 01:15:51.435; 
org.apache.solr.update.DirectUpdateHandler2; end_commit_flush
   [junit4]   2> WARN  - 2018-06-30 01:15:51.436; 
org.apache.solr.handler.dataimport.SimplePropertiesWriter; Unable to read: 
dataimport.properties
   [junit4]   2> INFO  - 2018-06-30 01:15:51.436; 
org.apache.solr.handler.dataimport.SimplePropertiesWriter; Wrote last indexed 
time to dataimport.properties
   [junit4]   2> INFO  - 2018-06-30 01:15:51.437; 
org.apache.solr.handler.dataimport.DocBuilder; Time taken = 0:0:0.123
   [junit4]   2> INFO  - 2018-06-30 01:15:51.437; 
org.apache.solr.update.processor.LogUpdateProcessorFactory; [collection1]  
webapp=null path=null 
params={debug=on&commit=true&dataConfig=<dataConfig>%0d%0a++<dataSource+type%3D'MockDataSource'+/>%0d%0a++<document>%0d%0a++++<entity+name%3D'db'+query%3D'select+*+from+x'>%0d%0a++++++<field+column%3D'dbid_s'+/>%0d%0a++++++<field+column%3D'dbdesc_s'+/>%0d%0a++++++<entity+name%3D'se'+processor%3D'SolrEntityProcessor'+query%3D'id:${db.dbid_s}'%0a+++++url%3D'http://127.0.0.1:59513/solr/collection1'+fields%3D'id,desc'>%0d%0a++++++++<field+column%3D'id'+/>%0d%0a++++++++<field+column%3D'desc'+/>%0d%0a++++++</entity>%0d%0a++++</entity>%0d%0a++</document>%0d%0a</dataConfig>%0d%0a&clean=true&wt=xml&command=full-import}{deleteByQuery=*:*,add=[1,
 2],commit=} 0 128
   [junit4]   2> INFO  - 2018-06-30 01:15:51.443; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=*:*&qt=&start=0&rows=20&version=2.2} hits=2 status=0 QTime=0
   [junit4]   2> INFO  - 2018-06-30 01:15:51.445; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=id:1&qt=&start=0&rows=20&version=2.2} hits=1 status=0 QTime=0
   [junit4]   2> INFO  - 2018-06-30 01:15:51.455; 
org.apache.solr.core.SolrCore.Request; [collection1]  webapp=null path=null 
params={q=id:2&qt=&start=0&rows=20&version=2.2} hits=1 status=0 QTime=1
   [junit4]   2> INFO  - 2018-06-30 01:15:51.457; 
org.apache.solr.SolrTestCaseJ4; ###deleteCore
   [junit4]   2> INFO  - 2018-06-30 01:15:51.457; 
org.apache.solr.core.CoreContainer; Shutting down CoreContainer 
instance=1899979189
   [junit4]   2> INFO  - 2018-06-30 01:15:51.458; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:51.458; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@29697ffd: rootName = null, 
domain = solr.node, service url = null, agent id = null] for registry solr.node 
/ com.codahale.metrics.MetricRegistry@513ee6c5
   [junit4]   2> INFO  - 2018-06-30 01:15:51.460; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jvm, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:51.460; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@a29985c: rootName = null, 
domain = solr.jvm, service url = null, agent id = null] for registry solr.jvm / 
com.codahale.metrics.MetricRegistry@1c07a7d6
   [junit4]   2> INFO  - 2018-06-30 01:15:51.461; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.jetty, tag=null
   [junit4]   2> INFO  - 2018-06-30 01:15:51.461; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@7699977c: rootName = null, 
domain = solr.jetty, service url = null, agent id = null] for registry 
solr.jetty / com.codahale.metrics.MetricRegistry@3d0540a5
   [junit4]   2> INFO  - 2018-06-30 01:15:51.462; 
org.apache.solr.core.SolrCore; [collection1]  CLOSING SolrCore 
org.apache.solr.core.SolrCore@7a6e70ab
   [junit4]   2> INFO  - 2018-06-30 01:15:51.462; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.core.collection1, tag=7a6e70ab
   [junit4]   2> INFO  - 2018-06-30 01:15:51.462; 
org.apache.solr.metrics.reporters.SolrJmxReporter; Closing reporter 
[org.apache.solr.metrics.reporters.SolrJmxReporter@7583af38: rootName = null, 
domain = solr.core.collection1, service url = null, agent id = null] for 
registry solr.core.collection1 / com.codahale.metrics.MetricRegistry@126961bb
   [junit4]   2> INFO  - 2018-06-30 01:15:51.474; 
org.eclipse.jetty.server.AbstractConnector; Stopped 
ServerConnector@5d0697f1{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
   [junit4]   2> INFO  - 2018-06-30 01:15:51.474; 
org.apache.solr.core.CoreContainer; Shutting down CoreContainer 
instance=232174601
   [junit4]   2> INFO  - 2018-06-30 01:15:51.475; 
org.apache.solr.metrics.SolrMetricManager; Closing metric reporters for 
registry=solr.node, tag=null
   [junit4]   2> INFO  - 2018-0

[...truncated too long message...]

rocessorEndToEnd
   [junit4] OK      17.7s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportFqParam
   [junit4] OK      2.13s J1 | 
TestSolrEntityProcessorEndToEnd.testCursorMarkNoSort
   [junit4] OK      2.83s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportInnerEntity
   [junit4] OK      3.84s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportFieldsParam
   [junit4] OK      6.28s J1 | TestSolrEntityProcessorEndToEnd.testFullImport
   [junit4] OK      4.26s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportWrongSolrUrl
   [junit4] OK      4.95s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportBadConfig
   [junit4] Completed [2/5] on J1 in 52.08s, 7 tests
   [junit4] 
   [junit4] Duplicate suite name used with XML reports: 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd. This may 
confuse tools that process XML reports. Set 'ignoreDuplicateSuites' to true to 
skip this message.
   [junit4] Suite: 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd
   [junit4] OK      4.34s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportFqParam
   [junit4] OK      3.16s J0 | 
TestSolrEntityProcessorEndToEnd.testCursorMarkNoSort
   [junit4] OK      3.06s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportInnerEntity
   [junit4] OK      3.41s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportFieldsParam
   [junit4] OK      3.09s J0 | TestSolrEntityProcessorEndToEnd.testFullImport
   [junit4] OK      1.47s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportWrongSolrUrl
   [junit4] OK      1.70s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportBadConfig
   [junit4] Completed [3/5] on J0 in 20.54s, 7 tests
   [junit4] 
   [junit4] Suite: 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd
   [junit4] OK      3.28s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportFqParam
   [junit4] OK      3.68s J1 | 
TestSolrEntityProcessorEndToEnd.testCursorMarkNoSort
   [junit4] OK      2.76s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportInnerEntity
   [junit4] OK      2.92s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportFieldsParam
   [junit4] OK      1.96s J1 | TestSolrEntityProcessorEndToEnd.testFullImport
   [junit4] OK      1.42s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportWrongSolrUrl
   [junit4] OK      2.23s J1 | 
TestSolrEntityProcessorEndToEnd.testFullImportBadConfig
   [junit4] Completed [4/5] on J1 in 18.63s, 7 tests
   [junit4] 
   [junit4] Suite: 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd
   [junit4] OK      1.45s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportFqParam
   [junit4] OK      1.67s J0 | 
TestSolrEntityProcessorEndToEnd.testCursorMarkNoSort
   [junit4] OK      1.51s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportInnerEntity
   [junit4] OK      3.50s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportFieldsParam
   [junit4] OK      4.95s J0 | TestSolrEntityProcessorEndToEnd.testFullImport
   [junit4] OK      2.07s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportWrongSolrUrl
   [junit4] OK      3.71s J0 | 
TestSolrEntityProcessorEndToEnd.testFullImportBadConfig
   [junit4] Completed [5/5] on J0 in 19.54s, 7 tests
   [junit4] 
   [junit4] JVM J0:     0.71 ..    92.26 =    91.55s
   [junit4] JVM J1:     0.71 ..    72.92 =    72.21s
   [junit4] Execution time total: 1 minute 32 seconds
   [junit4] Tests summary: 5 suites, 35 tests
   [junit4] Could not remove temporary path: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1
 (java.nio.file.DirectoryNotEmptyException: Remaining files: 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J1\temp])
   [junit4] Could not remove temporary path: 
C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J0
 (java.nio.file.DirectoryNotEmptyException: Remaining files: 
[C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows\solr\build\contrib\solr-dataimporthandler\test\J0\temp])
     [echo] 5 slowest tests:
[junit4:tophints]  30.38s | 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd
[junit4:tophints]  18.54s | org.apache.solr.handler.dataimport.TestErrorHandling
[junit4:tophints]   9.48s | org.apache.solr.handler.dataimport.TestFieldReader
[junit4:tophints]   7.25s | 
org.apache.solr.handler.dataimport.TestSqlEntityProcessor
[junit4:tophints]   6.52s | 
org.apache.solr.handler.dataimport.TestSqlEntityProcessorDelta

-check-totals:

test-nocompile:

BUILD SUCCESSFUL
Total time: 1 minute 35 seconds
[repro] Failures:
[repro]   0/5 failed: 
org.apache.solr.handler.dataimport.TestSolrEntityProcessorEndToEnd
[repro] Exiting with code 0

C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows>IF EXIST lucene\build move 
/y lucene\build lucene\build.repro 
        1 dir(s) moved.

C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows>IF EXIST solr\build move /y 
solr\build solr\build.repro 
        1 dir(s) moved.

C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows>IF EXIST lucene\build.orig 
move /y lucene\build.orig lucene\build 
        1 dir(s) moved.

C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows>IF EXIST solr\build.orig 
move /y solr\build.orig solr\build 
        1 dir(s) moved.

C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows>exit 0 
Archiving artifacts
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
java.lang.InterruptedException: no matches found within 10000
        at hudson.FilePath$ValidateAntFileMask.hasMatch(FilePath.java:2843)
        at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2722)
        at hudson.FilePath$ValidateAntFileMask.invoke(FilePath.java:2703)
        at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3082)
Also:   hudson.remoting.Channel$CallSiteStackTrace: Remote call to Windows VBOX
                at 
hudson.remoting.Channel.attachCallSiteStackTrace(Channel.java:1741)
                at 
hudson.remoting.UserRequest$ExceptionResponse.retrieve(UserRequest.java:357)
                at hudson.remoting.Channel.call(Channel.java:955)
                at hudson.FilePath.act(FilePath.java:1089)
                at hudson.FilePath.act(FilePath.java:1078)
                at hudson.FilePath.validateAntFileMask(FilePath.java:2701)
                at 
hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:243)
                at 
hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:81)
                at 
hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
                at 
hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:744)
                at 
hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:690)
                at hudson.model.Build$BuildExecution.post2(Build.java:186)
                at 
hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:635)
                at hudson.model.Run.execute(Run.java:1840)
                at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
                at 
hudson.model.ResourceController.execute(ResourceController.java:97)
                at hudson.model.Executor.run(Executor.java:429)
Caused: hudson.FilePath$TunneledInterruptedException
        at hudson.FilePath$FileCallableWrapper.call(FilePath.java:3084)
        at hudson.remoting.UserRequest.perform(UserRequest.java:212)
        at hudson.remoting.UserRequest.perform(UserRequest.java:54)
        at hudson.remoting.Request$2.run(Request.java:369)
        at 
hudson.remoting.InterceptingExecutorService$1.call(InterceptingExecutorService.java:72)
        at java.util.concurrent.FutureTask.run(Unknown Source)
        at java.util.concurrent.ThreadPoolExecutor.runWorker(Unknown Source)
        at java.util.concurrent.ThreadPoolExecutor$Worker.run(Unknown Source)
        at java.lang.Thread.run(Unknown Source)
Caused: java.lang.InterruptedException: java.lang.InterruptedException: no 
matches found within 10000
        at hudson.FilePath.act(FilePath.java:1091)
        at hudson.FilePath.act(FilePath.java:1078)
        at hudson.FilePath.validateAntFileMask(FilePath.java:2701)
        at hudson.tasks.ArtifactArchiver.perform(ArtifactArchiver.java:243)
        at 
hudson.tasks.BuildStepCompatibilityLayer.perform(BuildStepCompatibilityLayer.java:81)
        at hudson.tasks.BuildStepMonitor$1.perform(BuildStepMonitor.java:20)
        at 
hudson.model.AbstractBuild$AbstractBuildExecution.perform(AbstractBuild.java:744)
        at 
hudson.model.AbstractBuild$AbstractBuildExecution.performAllBuildSteps(AbstractBuild.java:690)
        at hudson.model.Build$BuildExecution.post2(Build.java:186)
        at 
hudson.model.AbstractBuild$AbstractBuildExecution.post(AbstractBuild.java:635)
        at hudson.model.Run.execute(Run.java:1840)
        at hudson.model.FreeStyleBuild.run(FreeStyleBuild.java:43)
        at hudson.model.ResourceController.execute(ResourceController.java:97)
        at hudson.model.Executor.run(Executor.java:429)
No artifacts found that match the file pattern 
"**/*.events,heapdumps/**,**/*_pid*.log". Configuration error?
[WARNINGS] Parsing warnings in console log with parser Java Compiler (javac)
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
<Git Blamer> Using GitBlamer to create author and commit information for all 
warnings.
<Git Blamer> GIT_COMMIT=5d25a1069a7000f54e1c2745347e8bae06d45ca0, 
workspace=C:\Users\jenkins\workspace\Lucene-Solr-7.x-Windows
[WARNINGS] Computing warning deltas based on reference build #662
Recording test results
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Build step 'Publish JUnit test result report' changed build result to UNSTABLE
Email was triggered for: Unstable (Test Failures)
Sending email for trigger: Unstable (Test Failures)
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
Setting 
ANT_1_8_2_HOME=C:\Users\jenkins\tools\hudson.tasks.Ant_AntInstallation\ANT_1.8.2
---------------------------------------------------------------------
To unsubscribe, e-mail: [email protected]
For additional commands, e-mail: [email protected]

Reply via email to