SuccessConsole Output

Skipping 1,681 KB.. Full Log
.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/a'
15:03:38.329 [qtp952533674-31] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:38.353 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 454480 bytes in 118 ms. path='/3/a'
15:03:38.360 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_86f7e437faa5a7fce15d1ddcb9eaeaea377667b8_0 into destFile a
15:03:38.417 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=11, fromRepositoryId="FileInProgressMarker", toRepositoryId="11", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:38.487 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [6f98e56f]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:38.487 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [6f98e56f]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 898 ms.
15:03:38.491 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/b'
15:03:38.526 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [6f98e56f]getCloseDeferredMillis: closeDeferredMillis=0
15:03:38.526 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [6f98e56f]close: Closing real LocalRepoManager immediately.
15:03:38.526 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [6f98e56f]_close: Shutting down real LocalRepoManager.
15:03:38.562 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='b688cf4482a5d417a885e892076c2e50d3f51722' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/b
15:03:38.671 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=12, fromRepositoryId="FileInProgressMarker", toRepositoryId="12", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:38.700 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/b'
15:03:38.729 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 24705 bytes in 29 ms. path='/3/b'
15:03:38.736 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_e9d71f5ee7c92d6dc9e92ffdad17b8bd49418f98_0 into destFile b
15:03:38.843 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=12, fromRepositoryId="FileInProgressMarker", toRepositoryId="12", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:38.854 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/c'
15:03:38.903 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='6094f00404874a9bbce6fe5421e3c24d3b2fa915' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/c
15:03:38.932 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=13, fromRepositoryId="FileInProgressMarker", toRepositoryId="13", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:39.019 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:39.019 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/c'
15:03:39.031 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:03:39.031 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:39.032 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:39.032 [main] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 remoteRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 localRepositoryRevisionSynced=84 localRepositoryRevisionInProgress=89
15:03:39.042 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:39.076 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:39.076 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:39.076 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:39.076 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:39.077 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 56.31%
15:03:39.078 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/3'
15:03:39.090 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [4a8d8ed5]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:39.093 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [4a8d8ed5]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:39.115 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 391320 bytes in 96 ms. path='/3/c'
15:03:39.123 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_84a516841ba77a5b4648de2cd0dfcb30ea46dbb4_0 into destFile c
15:03:39.771 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=13, fromRepositoryId="FileInProgressMarker", toRepositoryId="13", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:39.782 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/d'
15:03:39.830 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='620d38785a09142718f19474f6760807679aac08' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/d
15:03:39.889 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=14, fromRepositoryId="FileInProgressMarker", toRepositoryId="14", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:39.917 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/d'
15:03:39.955 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 62700 bytes in 38 ms. path='/3/d'
15:03:39.962 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_3c363836cf4e16666669a25da280a1865c2d2874_0 into destFile d
15:03:40.047 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=14, fromRepositoryId="FileInProgressMarker", toRepositoryId="14", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:40.122 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 44.48%
15:03:40.122 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/5#/e'
15:03:40.194 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='1834bba725495ef7162d58ff458339ecd91c96c4' to.sha1='<NoInstanceOf_NormalFileDto>'): /5#/e
15:03:40.225 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=15, fromRepositoryId="FileInProgressMarker", toRepositoryId="15", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:40.227 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/5#/e'
15:03:40.231 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:40.333 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 460856 bytes in 106 ms. path='/5#/e'
15:03:40.340 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_58e6b3a414a1e090dfc6029add0f3555ccba127f_0 into destFile e
15:03:40.364 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [4a8d8ed5]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:40.364 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [4a8d8ed5]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 1269 ms.
15:03:40.379 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=15, fromRepositoryId="FileInProgressMarker", toRepositoryId="15", path="e7c785c2-675e-49b2-9a73-18a70bc18f73"] on repo=e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:40.386 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 49.75%
15:03:40.398 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [4a8d8ed5]getCloseDeferredMillis: closeDeferredMillis=0
15:03:40.398 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [4a8d8ed5]close: Closing real LocalRepoManager immediately.
15:03:40.398 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [4a8d8ed5]_close: Shutting down real LocalRepoManager.
15:03:40.428 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [220940da]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:40.429 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [220940da]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:40.467 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac localRepositoryRevisionSynced=3
15:03:40.489 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 transaction.localRevision=84 remoteFromLocalRevision=3
15:03:40.497 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncUp: fromID=e9c2dfa3-e084-42e2-9a15-b203151cc9ac from='target/repo/k8zx2f6z-xo9wi-local' toID=e7c785c2-675e-49b2-9a73-18a70bc18f73 to='https://localhost:13393/e7c785c2-675e-49b2-9a73-18a70bc18f73'
15:03:40.544 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:40.547 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:40.548 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: e7c785c2-675e-49b2-9a73-18a70bc18f73
15:03:40.548 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:40.548 [main] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 localRepositoryRevisionSynced=-1 localRepositoryRevisionInProgress=84
15:03:40.556 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:40.566 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:40.566 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:40.566 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:40.566 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:40.567 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 63.43%
15:03:40.567 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 74.63%
15:03:40.589 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 localRepositoryRevisionSynced=84
15:03:40.629 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac transaction.localRevision=6 remoteFromLocalRevision=84
15:03:40.633 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=e7c785c2-675e-49b2-9a73-18a70bc18f73 from='https://localhost:13393/e7c785c2-675e-49b2-9a73-18a70bc18f73' toID=e9c2dfa3-e084-42e2-9a15-b203151cc9ac to='target/repo/k8zx2f6z-xo9wi-local', fromRepoLocalSync=false
15:03:40.634 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2f6z-xo9wi-local/.cloudstore-repo/tmp/ChangeSetDto.e7c785c2-675e-49b2-9a73-18a70bc18f73.null.xml.gz
15:03:40.667 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:40.670 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: e7c785c2-675e-49b2-9a73-18a70bc18f73
15:03:40.670 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:40.670 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:40.670 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac localRepositoryRevisionSynced=3 localRepositoryRevisionInProgress=6
15:03:40.672 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:40.674 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:40.674 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:40.674 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:40.674 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:40.686 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2f6z-xo9wi-local/.cloudstore-repo/tmp/ChangeSetDto.e7c785c2-675e-49b2-9a73-18a70bc18f73.null.xml.gz
15:03:40.686 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 88.31%
15:03:40.686 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 99.50%
15:03:40.714 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac localRepositoryRevisionSynced=6
15:03:40.726 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 transaction.localRevision=87 remoteFromLocalRevision=6
15:03:40.729 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 100.00%
15:03:40.730 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:40.866 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [220940da]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:40.867 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [220940da]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 437 ms.
15:03:40.898 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 0.50%
15:03:40.908 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=e7c785c2-675e-49b2-9a73-18a70bc18f73 from='https://localhost:13393/e7c785c2-675e-49b2-9a73-18a70bc18f73' toID=e9c2dfa3-e084-42e2-9a15-b203151cc9ac to='target/repo/k8zx2f6z-xo9wi-local', fromRepoLocalSync=true
15:03:40.908 [pool-8-thread-1] INFO  c.c.c.c.r.s.RepoToRepoSync - sync: locally syncing e9c2dfa3-e084-42e2-9a15-b203151cc9ac ('target/repo/k8zx2f6z-xo9wi-local')
15:03:40.914 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2f6z-xo9wi-local/.cloudstore-repo/tmp/ChangeSetDto.e7c785c2-675e-49b2-9a73-18a70bc18f73.6.xml.gz
15:03:40.917 [pool-8-thread-1] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 12.94%
15:03:40.926 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 1.00%
15:03:40.929 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 50.00%
15:03:40.934 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 55.72%
15:03:40.957 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 64.70%
15:03:40.969 [pool-8-thread-1] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 19.03%
15:03:40.993 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 74.50%
15:03:41.011 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 84.30%
15:03:41.029 [pool-8-thread-1] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 24.06%
15:03:41.032 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [220940da]getCloseDeferredMillis: closeDeferredMillis=0
15:03:41.032 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [220940da]close: Closing real LocalRepoManager immediately.
15:03:41.032 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [220940da]_close: Shutting down real LocalRepoManager.
15:03:41.079 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 62.42%
15:03:41.079 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 68.52%
15:03:41.079 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/zzz'
15:03:41.109 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [31805df5]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:41.109 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [31805df5]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:41.178 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 94.10%
15:03:41.270 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 100.00%
15:03:41.279 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:41.281 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: e7c785c2-675e-49b2-9a73-18a70bc18f73
15:03:41.281 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:41.281 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:41.281 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac localRepositoryRevisionSynced=6 localRepositoryRevisionInProgress=9
15:03:41.312 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 2 ModificationDtos took 1 ms.
15:03:41.339 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:41.339 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:41.339 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:41.339 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:41.351 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2f6z-xo9wi-local/.cloudstore-repo/tmp/ChangeSetDto.e7c785c2-675e-49b2-9a73-18a70bc18f73.6.xml.gz
15:03:41.351 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 30.16%
15:03:41.352 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/2'
15:03:41.391 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/2/1 {11 11ä11#+} 1'
15:03:41.415 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncModifications: Moving from '/2/1 {11 11ä11#+} 1/b' to '/2/b'
15:03:41.476 [qtp952533674-31] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:41.564 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncModifications: Deleting '/2/1 {11 11ä11#+} 1/b'
15:03:41.577 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 37.16%
15:03:41.579 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 42.75%
15:03:41.579 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/2/b'
15:03:41.612 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - File is already equal on destination side (sha1='080f0b5ca8adb8fe6ea15f2371b59f6e80e33b45'): /2/b
15:03:41.613 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 48.35%
15:03:41.641 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [31805df5]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:41.642 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [31805df5]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 532 ms.
15:03:41.687 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [31805df5]getCloseDeferredMillis: closeDeferredMillis=0
15:03:41.687 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [31805df5]close: Closing real LocalRepoManager immediately.
15:03:41.687 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [31805df5]_close: Shutting down real LocalRepoManager.
15:03:41.694 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac localRepositoryRevisionSynced=9
15:03:41.704 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 transaction.localRevision=91 remoteFromLocalRevision=9
15:03:41.715 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncUp: fromID=e9c2dfa3-e084-42e2-9a15-b203151cc9ac from='target/repo/k8zx2f6z-xo9wi-local' toID=e7c785c2-675e-49b2-9a73-18a70bc18f73 to='https://localhost:13393/e7c785c2-675e-49b2-9a73-18a70bc18f73'
15:03:41.728 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [37c91976]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:41.729 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [37c91976]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:41.753 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:41.758 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:41.759 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: e7c785c2-675e-49b2-9a73-18a70bc18f73
15:03:41.759 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:41.759 [main] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 localRepositoryRevisionSynced=84 localRepositoryRevisionInProgress=91
15:03:41.789 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 2 ModificationDtos took 0 ms.
15:03:41.791 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:41.791 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:41.792 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:41.793 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:41.794 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 57.84%
15:03:41.795 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncModifications: Moving from '/2/1 {11 11ä11#+} 1/b' to '/2/b'
15:03:41.806 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncModifications: Deleting '/2/1 {11 11ä11#+} 1/b'
15:03:41.826 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 69.03%
15:03:41.826 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 74.63%
15:03:41.870 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 localRepositoryRevisionSynced=91
15:03:41.975 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac transaction.localRevision=12 remoteFromLocalRevision=91
15:03:41.983 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=e7c785c2-675e-49b2-9a73-18a70bc18f73 from='https://localhost:13393/e7c785c2-675e-49b2-9a73-18a70bc18f73' toID=e9c2dfa3-e084-42e2-9a15-b203151cc9ac to='target/repo/k8zx2f6z-xo9wi-local', fromRepoLocalSync=false
15:03:41.984 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2f6z-xo9wi-local/.cloudstore-repo/tmp/ChangeSetDto.e7c785c2-675e-49b2-9a73-18a70bc18f73.null.xml.gz
15:03:42.009 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:42.011 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: e7c785c2-675e-49b2-9a73-18a70bc18f73
15:03:42.012 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: e9c2dfa3-e084-42e2-9a15-b203151cc9ac
15:03:42.012 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:42.012 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac localRepositoryRevisionSynced=9 localRepositoryRevisionInProgress=12
15:03:42.014 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:42.015 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:42.015 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:42.015 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:42.015 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:42.020 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2f6z-xo9wi-local/.cloudstore-repo/tmp/ChangeSetDto.e7c785c2-675e-49b2-9a73-18a70bc18f73.null.xml.gz
15:03:42.020 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 88.31%
15:03:42.021 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 99.50%
15:03:42.034 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 remoteRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac localRepositoryRevisionSynced=12
15:03:42.042 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=e9c2dfa3-e084-42e2-9a15-b203151cc9ac remoteRepositoryId=e7c785c2-675e-49b2-9a73-18a70bc18f73 transaction.localRevision=94 remoteFromLocalRevision=12
15:03:42.044 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 100.00%
15:03:42.123 [pool-4-thread-1] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:42.123 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [2f3d5cd]getCloseDeferredMillis: closeDeferredMillis=20000
15:03:42.124 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [2f3d5cd]close: Deferring shut down of real LocalRepoManager 20000 ms.
15:03:42.125 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [452d6fd]getCloseDeferredMillis: closeDeferredMillis=20000
15:03:42.125 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [452d6fd]close: Deferring shut down of real LocalRepoManager 20000 ms.
15:03:42.129 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [3b26afbc]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi7-ojp6d-local'
15:03:42.131 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [3b26afbc]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi7-ojp6d-local' locked successfully.
15:03:42.299 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [37c91976]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:42.300 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [37c91976]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 570 ms.
15:03:42.351 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [37c91976]getCloseDeferredMillis: closeDeferredMillis=0
15:03:42.351 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [37c91976]close: Closing real LocalRepoManager immediately.
15:03:42.351 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [37c91976]_close: Shutting down real LocalRepoManager.
15:03:42.426 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='fb6434b2a678151efd8008d801a6d35c6e4347c2' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/zzz
Apr 14, 2020 3:03:42 PM org.glassfish.jersey.client.JerseyInvocation validateHttpMethodAndEntity
WARNING: Entity must not be null for http method PUT.
15:03:42.485 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [15ac0a68]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:42.486 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [15ac0a68]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:42.783 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:42.936 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [15ac0a68]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:42.937 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [15ac0a68]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 450 ms.
15:03:42.967 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [15ac0a68]getCloseDeferredMillis: closeDeferredMillis=0
15:03:42.967 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [15ac0a68]close: Closing real LocalRepoManager immediately.
15:03:42.967 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [15ac0a68]_close: Shutting down real LocalRepoManager.
15:03:43.405 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [44843fcd]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:43.406 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [44843fcd]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:43.779 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:43.975 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [44843fcd]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:43.976 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [44843fcd]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 568 ms.
15:03:44.126 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [44843fcd]getCloseDeferredMillis: closeDeferredMillis=0
15:03:44.127 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [44843fcd]close: Closing real LocalRepoManager immediately.
15:03:44.127 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [44843fcd]_close: Shutting down real LocalRepoManager.
15:03:44.486 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=16, fromRepositoryId="FileInProgressMarker", toRepositoryId="16", path="b15c81a8-9fa6-46b0-9d89-13455c2ec1f1"] on repo=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:03:44.488 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/zzz'
15:03:44.546 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [58185851]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:44.547 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [58185851]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:44.880 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:45.013 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [58185851]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:45.014 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [58185851]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 466 ms.
15:03:45.045 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [58185851]getCloseDeferredMillis: closeDeferredMillis=0
15:03:45.046 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [58185851]close: Closing real LocalRepoManager immediately.
15:03:45.046 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [58185851]_close: Shutting down real LocalRepoManager.
15:03:45.262 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [698e1cb5]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:45.262 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [698e1cb5]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:45.609 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:45.795 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [698e1cb5]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:45.796 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [698e1cb5]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 531 ms.
15:03:45.866 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [698e1cb5]getCloseDeferredMillis: closeDeferredMillis=0
15:03:45.866 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [698e1cb5]close: Closing real LocalRepoManager immediately.
15:03:45.866 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [698e1cb5]_close: Shutting down real LocalRepoManager.
15:03:45.903 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 187220 bytes in 1415 ms. path='/3/zzz'
Apr 14, 2020 3:03:45 PM org.glassfish.jersey.client.JerseyInvocation validateHttpMethodAndEntity
WARNING: Entity must not be null for http method PUT.
15:03:45.915 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [710ae933]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:45.915 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [710ae933]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:46.188 [qtp952533674-31] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:46.366 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [710ae933]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:46.366 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [710ae933]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 450 ms.
15:03:46.403 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [710ae933]getCloseDeferredMillis: closeDeferredMillis=0
15:03:46.403 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [710ae933]close: Closing real LocalRepoManager immediately.
15:03:46.403 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [710ae933]_close: Shutting down real LocalRepoManager.
15:03:46.433 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [687b1a46]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:46.433 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [687b1a46]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:46.750 [qtp952533674-31] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:46.909 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [687b1a46]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:46.910 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [687b1a46]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 475 ms.
15:03:46.968 [qtp952533674-31] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_40fa37ec00c761c7dbb6ebdee6d4a260b922f5f4_0 into destFile zzz
15:03:47.009 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [3b26afbc]initPersistenceManagerFactory: repositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:47.015 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [3b26afbc]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 3251 ms.
localRoot: k8zx2yi7-ojp6d-local
localRepositoryId: 1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:47.047 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [23ac164d]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi8-so4p6-remote'
15:03:47.051 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [23ac164d]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi8-so4p6-remote' locked successfully.
15:03:47.073 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [687b1a46]getCloseDeferredMillis: closeDeferredMillis=0
15:03:47.073 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [687b1a46]close: Closing real LocalRepoManager immediately.
15:03:47.073 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [687b1a46]_close: Shutting down real LocalRepoManager.
15:03:47.530 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=16, fromRepositoryId="FileInProgressMarker", toRepositoryId="16", path="b15c81a8-9fa6-46b0-9d89-13455c2ec1f1"] on repo=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:03:47.595 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 72.59%
15:03:47.622 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 remoteRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 localRepositoryRevisionSynced=89
15:03:47.686 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5909084f]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:47.686 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5909084f]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:47.983 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:48.111 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5909084f]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:48.112 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5909084f]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 424 ms.
15:03:48.140 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5909084f]getCloseDeferredMillis: closeDeferredMillis=0
15:03:48.140 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5909084f]close: Closing real LocalRepoManager immediately.
15:03:48.140 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5909084f]_close: Shutting down real LocalRepoManager.
15:03:48.202 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [16e7d807]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:48.203 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [16e7d807]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:48.612 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:48.787 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [16e7d807]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:48.787 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [16e7d807]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 582 ms.
15:03:48.855 [qtp952533674-33] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 transaction.localRevision=15 remoteFromLocalRevision=89
15:03:48.858 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [16e7d807]getCloseDeferredMillis: closeDeferredMillis=0
15:03:48.858 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [16e7d807]close: Closing real LocalRepoManager immediately.
15:03:48.858 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [16e7d807]_close: Shutting down real LocalRepoManager.
15:03:48.980 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=eb8fbfb3-b3da-4096-b139-355105b7c3e0 from='https://localhost:3541/eb8fbfb3-b3da-4096-b139-355105b7c3e0' toID=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 to='target/repo/k8zx21al-4t1mi-local', fromRepoLocalSync=false
15:03:48.981 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local/.cloudstore-repo/tmp/ChangeSetDto.eb8fbfb3-b3da-4096-b139-355105b7c3e0.null.xml.gz
15:03:48.994 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [12100fba]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:48.994 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [12100fba]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:50.114 [qtp952533674-31] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:50.251 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [12100fba]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:50.251 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [12100fba]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 1255 ms.
15:03:50.286 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [12100fba]getCloseDeferredMillis: closeDeferredMillis=0
15:03:50.286 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [12100fba]close: Closing real LocalRepoManager immediately.
15:03:50.286 [qtp952533674-31] INFO  c.c.c.l.LocalRepoManagerImpl - [12100fba]_close: Shutting down real LocalRepoManager.
15:03:50.413 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7ddd09ab]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:50.414 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7ddd09ab]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:50.649 [pool-4-thread-1] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:50.815 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7ddd09ab]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:50.815 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7ddd09ab]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 399 ms.
15:03:50.890 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:50.893 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:50.893 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:03:50.893 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:50.893 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 localRepositoryRevisionSynced=8 localRepositoryRevisionInProgress=15
15:03:50.901 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:50.912 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:50.912 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:50.913 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:50.913 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:50.913 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7ddd09ab]getCloseDeferredMillis: closeDeferredMillis=0
15:03:50.914 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7ddd09ab]close: Closing real LocalRepoManager immediately.
15:03:50.914 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7ddd09ab]_close: Shutting down real LocalRepoManager.
15:03:50.959 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local/.cloudstore-repo/tmp/ChangeSetDto.eb8fbfb3-b3da-4096-b139-355105b7c3e0.null.xml.gz
15:03:50.959 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 88.31%
15:03:50.960 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 99.50%
15:03:50.967 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [2a888515]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:50.967 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [2a888515]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:51.225 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:51.366 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [2a888515]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:51.367 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [2a888515]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 399 ms.
15:03:51.405 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [2a888515]getCloseDeferredMillis: closeDeferredMillis=0
15:03:51.405 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [2a888515]close: Closing real LocalRepoManager immediately.
15:03:51.405 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [2a888515]_close: Shutting down real LocalRepoManager.
15:03:51.446 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [39451f99]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:51.447 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [39451f99]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:51.796 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:51.999 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [39451f99]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:52.000 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [39451f99]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 551 ms.
15:03:52.106 [qtp952533674-33] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 localRepositoryRevisionSynced=15
15:03:52.108 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [39451f99]getCloseDeferredMillis: closeDeferredMillis=0
15:03:52.108 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [39451f99]close: Closing real LocalRepoManager immediately.
15:03:52.108 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [39451f99]_close: Shutting down real LocalRepoManager.
15:03:52.143 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 remoteRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 transaction.localRevision=94 remoteFromLocalRevision=15
15:03:52.147 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 100.00%
15:03:52.148 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [900ffc4]getCloseDeferredMillis: closeDeferredMillis=0
15:03:52.148 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [900ffc4]close: Closing real LocalRepoManager immediately.
15:03:52.148 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [900ffc4]_close: Shutting down real LocalRepoManager.
15:03:52.459 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - ************************************************************************************
15:03:52.459 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Restoring backup: 'target/repo/k8zx21am-ado5-remote.bak' => 'target/repo/k8zx21am-ado5-remote'
15:03:52.519 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Restored backup: 'target/repo/k8zx21am-ado5-remote.bak' => 'target/repo/k8zx21am-ado5-remote'
15:03:52.519 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - ************************************************************************************
15:03:52.521 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [5702e6f3]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local'
15:03:52.521 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [5702e6f3]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local' locked successfully.
15:03:52.783 [main] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:52.937 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [5702e6f3]initPersistenceManagerFactory: repositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:03:52.937 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [5702e6f3]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 414 ms.
15:03:52.957 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [23ac164d]initPersistenceManagerFactory: repositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611
15:03:52.962 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [23ac164d]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 2548 ms.
remoteRoot: k8zx2yi8-so4p6-remote
remoteRepositoryId: 82c730b0-6d77-4ff3-9b8f-43aa33c0c611
15:03:53.191 [main] INFO  c.c.c.l.s.LocalServer - logMemoryStats: max=3.9 GiB, allocated=105.0 MiB, used=43.3 MiB, available=3.9 GiB
15:03:53.307 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7034e098]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:53.307 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7034e098]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:53.674 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
Successfully requested to connect the following local and remote repositories:

  localRepository.repositoryId = 1474cc91-54f7-44a8-a488-822fd0c9cd7a
  localRepository.localRoot = /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi7-ojp6d-local
  localRepository.publicKeySha1 = 8C:ED:04:F9:17:0E:AF:B9:B9:F9:C9:56:6C:A4:73:41:99:7A:8F:1A

  remoteRepository.repositoryId = 82c730b0-6d77-4ff3-9b8f-43aa33c0c611
  remoteRepository.remoteRoot = https://localhost:13393/82c730b0-6d77-4ff3-9b8f-43aa33c0c611
  remoteRepository.publicKeySha1 = D1:42:44:70:8C:39:A0:1E:EC:9C:4D:68:0E:C5:2E:F4:23:CE:BB:1C

Please verify the 'publicKeySha1' fingerprints! If they do not match the fingerprints shown on the server, someone is attacking you and you must cancel this request immediately! To cancel the request, use this command:

  cloudstore dropRepoConnection 1474cc91-54f7-44a8-a488-822fd0c9cd7a 82c730b0-6d77-4ff3-9b8f-43aa33c0c611
15:03:53.797 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7034e098]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:53.797 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7034e098]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 488 ms.
15:03:53.822 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7034e098]getCloseDeferredMillis: closeDeferredMillis=0
15:03:53.823 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7034e098]close: Closing real LocalRepoManager immediately.
15:03:53.823 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7034e098]_close: Shutting down real LocalRepoManager.
15:03:53.855 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 0.50%
15:03:53.860 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=eb8fbfb3-b3da-4096-b139-355105b7c3e0 from='https://localhost:3541/eb8fbfb3-b3da-4096-b139-355105b7c3e0' toID=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 to='target/repo/k8zx21al-4t1mi-local', fromRepoLocalSync=true
15:03:53.860 [pool-9-thread-1] INFO  c.c.c.c.r.s.RepoToRepoSync - sync: locally syncing b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 ('target/repo/k8zx21al-4t1mi-local')
15:03:53.893 [pool-9-thread-1] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 12.94%
15:03:53.915 [main] INFO  c.c.c.l.s.LocalServer - logMemoryStats: max=3.9 GiB, allocated=105.0 MiB, used=36.8 MiB, available=3.9 GiB
15:03:53.953 [pool-9-thread-1] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 19.03%
Successfully accepted the connection request for the following local and remote repositories:

  localRepository.repositoryId = 82c730b0-6d77-4ff3-9b8f-43aa33c0c611
  localRepository.localRoot = /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi8-so4p6-remote
  localRepository.publicKeySha1 = D1:42:44:70:8C:39:A0:1E:EC:9C:4D:68:0E:C5:2E:F4:23:CE:BB:1C

  remoteRepository.repositoryId = 1474cc91-54f7-44a8-a488-822fd0c9cd7a
  remoteRepository.publicKeySha1 = 8C:ED:04:F9:17:0E:AF:B9:B9:F9:C9:56:6C:A4:73:41:99:7A:8F:1A

Please verify the 'publicKeySha1' fingerprints! If they do not match the fingerprints shown on the client, someone is attacking you and you must cancel this request immediately! To cancel the request, use this command:

  cloudstore dropRepoConnection 82c730b0-6d77-4ff3-9b8f-43aa33c0c611 1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:54.011 [pool-9-thread-1] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 24.15%
15:03:54.072 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local/.cloudstore-repo/tmp/ChangeSetDto.eb8fbfb3-b3da-4096-b139-355105b7c3e0.15.xml.gz
15:03:54.083 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [610dc89c]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:54.085 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [610dc89c]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:54.349 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:54.500 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [610dc89c]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:54.501 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [610dc89c]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 414 ms.
15:03:54.549 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [610dc89c]getCloseDeferredMillis: closeDeferredMillis=0
15:03:54.549 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [610dc89c]close: Closing real LocalRepoManager immediately.
15:03:54.549 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [610dc89c]_close: Shutting down real LocalRepoManager.
15:03:54.673 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getAuthToken: got new AuthToken: clientRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 serverRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 renewalDateTime=2020-04-14T13:33:20.877Z expiryDateTime=2020-04-14T14:03:20.877Z
15:03:54.682 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [3df21e94]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:54.683 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [3df21e94]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:54.991 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:55.124 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [3df21e94]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:55.125 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [3df21e94]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 442 ms.
15:03:55.165 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [3df21e94]getCloseDeferredMillis: closeDeferredMillis=0
15:03:55.166 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [3df21e94]close: Closing real LocalRepoManager immediately.
15:03:55.166 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [3df21e94]_close: Shutting down real LocalRepoManager.
15:03:55.447 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 0.50%
15:03:55.449 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 from='https://localhost:13393/82c730b0-6d77-4ff3-9b8f-43aa33c0c611' toID=1474cc91-54f7-44a8-a488-822fd0c9cd7a to='target/repo/k8zx2yi7-ojp6d-local', fromRepoLocalSync=true
15:03:55.449 [pool-9-thread-1] INFO  c.c.c.c.r.s.RepoToRepoSync - sync: locally syncing 1474cc91-54f7-44a8-a488-822fd0c9cd7a ('target/repo/k8zx2yi7-ojp6d-local')
15:03:55.468 [pool-9-thread-1] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 12.94%
15:03:55.468 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [73032e29]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:55.470 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [73032e29]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:55.477 [pool-9-thread-1] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 25.12%
15:03:55.479 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi7-ojp6d-local/.cloudstore-repo/tmp/ChangeSetDto.82c730b0-6d77-4ff3-9b8f-43aa33c0c611.-1.xml.gz
15:03:55.572 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getAuthToken: got new AuthToken: clientRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a serverRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 renewalDateTime=2020-04-14T13:33:55.491Z expiryDateTime=2020-04-14T14:03:55.491Z
15:03:55.581 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 1.00%
15:03:55.583 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 50.00%
15:03:55.619 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 55.03%
15:03:55.752 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 64.60%
15:03:55.786 [pool-4-thread-1] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:55.787 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 74.40%
15:03:55.868 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 84.20%
15:03:55.925 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [73032e29]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:55.925 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [73032e29]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 453 ms.
15:03:55.947 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 1.00%
15:03:55.960 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 50.00%
15:03:55.983 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 55.72%
15:03:55.985 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 94.00%
15:03:56.013 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 64.70%
15:03:56.021 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 74.50%
15:03:56.039 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 84.30%
15:03:56.071 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 94.10%
15:03:56.099 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 100.00%
15:03:56.102 [pool-4-thread-1] INFO  c.c.c.l.t.FileRepoTransport - Local sync...: 100.00%
15:03:56.115 [pool-4-thread-1] WARN  c.c.c.l.t.ChangeSetDtoBuilder - prepareLastSyncToRemoteRepo: Enabling resyncMode! lastSyncToRemoteRepoLocalRepositoryRevisionSynced=15 overwrites lastSyncToRemoteRepo.localRepositoryRevisionSynced=6
15:03:56.137 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:56.141 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: 82c730b0-6d77-4ff3-9b8f-43aa33c0c611
15:03:56.141 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: 1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:56.141 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:56.141 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 remoteRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a localRepositoryRevisionSynced=-1 localRepositoryRevisionInProgress=3
15:03:56.143 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:56.150 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:56.150 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:03:56.150 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:56.150 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 localRepositoryRevisionSynced=15 localRepositoryRevisionInProgress=8
15:03:56.151 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:56.162 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:56.170 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:56.170 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:56.170 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:56.170 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:56.171 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [73032e29]getCloseDeferredMillis: closeDeferredMillis=0
15:03:56.171 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [73032e29]close: Closing real LocalRepoManager immediately.
15:03:56.171 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [73032e29]_close: Shutting down real LocalRepoManager.
15:03:56.199 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:56.199 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:56.199 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:56.200 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:56.230 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi7-ojp6d-local/.cloudstore-repo/tmp/ChangeSetDto.82c730b0-6d77-4ff3-9b8f-43aa33c0c611.-1.xml.gz
15:03:56.232 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path=''
15:03:56.329 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/#4'
15:03:56.354 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local/.cloudstore-repo/tmp/ChangeSetDto.eb8fbfb3-b3da-4096-b139-355105b7c3e0.15.xml.gz
15:03:56.355 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 38.56%
15:03:56.355 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 49.75%
15:03:56.362 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [8f2dc15]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:56.362 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [8f2dc15]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:56.367 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/1 {11 11ä11#+} 1'
15:03:56.386 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 30.33%
15:03:56.386 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/2'
15:03:56.408 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/2/1 {11 11ä11#+} 1'
15:03:56.428 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/3'
15:03:56.453 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/5#'
15:03:56.489 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 35.59%
15:03:56.490 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 40.86%
15:03:56.491 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/#4/#b'
15:03:56.542 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='1c739cf6e5b090ed95333527bce810a32070ca9b' to.sha1='<NoInstanceOf_NormalFileDto>'): /#4/#b
15:03:56.616 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=1, fromRepositoryId="FileInProgressMarker", toRepositoryId="1", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:56.621 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/#4/#b'
15:03:56.626 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:56.713 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 210482 bytes in 92 ms. path='/#4/#b'
15:03:56.721 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_c691e3d4c979adbf07e3b97e33fdf3c89ed246f6_0 into destFile #b
15:03:56.782 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=1, fromRepositoryId="FileInProgressMarker", toRepositoryId="1", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:56.806 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/#4/a'
15:03:56.811 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [8f2dc15]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:56.812 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [8f2dc15]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 448 ms.
15:03:56.853 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [8f2dc15]getCloseDeferredMillis: closeDeferredMillis=0
15:03:56.853 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [8f2dc15]close: Closing real LocalRepoManager immediately.
15:03:56.854 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [8f2dc15]_close: Shutting down real LocalRepoManager.
15:03:56.885 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='0fc2cdb13c84692ea39b528556fc56d11ea3af67' to.sha1='<NoInstanceOf_NormalFileDto>'): /#4/a
15:03:56.904 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5836a023]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:56.905 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5836a023]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:56.931 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=2, fromRepositoryId="FileInProgressMarker", toRepositoryId="2", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:56.968 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/#4/a'
15:03:57.226 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 820165 bytes in 257 ms. path='/#4/a'
15:03:57.231 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:57.235 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_86f7e437faa5a7fce15d1ddcb9eaeaea377667b8_0 into destFile a
15:03:57.297 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=2, fromRepositoryId="FileInProgressMarker", toRepositoryId="2", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:57.314 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/#4/c+'
15:03:57.381 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='d9ec27ca58f1c9fdd41d71d3fc3803db880c446b' to.sha1='<NoInstanceOf_NormalFileDto>'): /#4/c+
15:03:57.430 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=3, fromRepositoryId="FileInProgressMarker", toRepositoryId="3", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:57.448 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/#4/c+'
15:03:57.454 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5836a023]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:57.455 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5836a023]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 549 ms.
15:03:57.575 [qtp952533674-33] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 localRepositoryRevisionSynced=8
15:03:57.580 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5836a023]getCloseDeferredMillis: closeDeferredMillis=0
15:03:57.581 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5836a023]close: Closing real LocalRepoManager immediately.
15:03:57.581 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [5836a023]_close: Shutting down real LocalRepoManager.
15:03:57.597 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 558930 bytes in 149 ms. path='/#4/c+'
15:03:57.603 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_8a30244b83c6cac3c79f8f95d30f96579c0f4c0b_0 into destFile c+
15:03:57.647 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=3, fromRepositoryId="FileInProgressMarker", toRepositoryId="3", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:57.658 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/#4/d$'
15:03:57.663 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 remoteRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 transaction.localRevision=95 remoteFromLocalRevision=8
15:03:57.666 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncUp: fromID=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 from='target/repo/k8zx21al-4t1mi-local' toID=eb8fbfb3-b3da-4096-b139-355105b7c3e0 to='https://localhost:3541/eb8fbfb3-b3da-4096-b139-355105b7c3e0'
15:03:57.673 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1d851edc]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:57.673 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1d851edc]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:57.737 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='8736490dc32a4be3e82c69b2fde1963bc2a4566c' to.sha1='<NoInstanceOf_NormalFileDto>'): /#4/d$
15:03:57.767 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=4, fromRepositoryId="FileInProgressMarker", toRepositoryId="4", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:57.773 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/#4/d$'
15:03:57.835 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 173228 bytes in 62 ms. path='/#4/d$'
15:03:57.846 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_a93a212f7eca012dceb852f364cc2c34026f0dd8_0 into destFile d$
15:03:57.877 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=4, fromRepositoryId="FileInProgressMarker", toRepositoryId="4", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:57.901 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/1 {11 11ä11#+} 1/a'
15:03:57.938 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:57.973 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='225e56796b68106385da52ac9718591509b23a0a' to.sha1='<NoInstanceOf_NormalFileDto>'): /1 {11 11ä11#+} 1/a
15:03:58.009 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=5, fromRepositoryId="FileInProgressMarker", toRepositoryId="5", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:58.014 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/1 {11 11ä11#+} 1/a'
15:03:58.100 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1d851edc]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:58.101 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1d851edc]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 427 ms.
15:03:58.132 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1d851edc]getCloseDeferredMillis: closeDeferredMillis=0
15:03:58.133 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1d851edc]close: Closing real LocalRepoManager immediately.
15:03:58.133 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1d851edc]_close: Shutting down real LocalRepoManager.
15:03:58.151 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 410228 bytes in 137 ms. path='/1 {11 11ä11#+} 1/a'
15:03:58.159 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_86f7e437faa5a7fce15d1ddcb9eaeaea377667b8_0 into destFile a
15:03:58.171 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [63acd7e4]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:58.172 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [63acd7e4]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:58.194 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=5, fromRepositoryId="FileInProgressMarker", toRepositoryId="5", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:58.203 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/1 {11 11ä11#+} 1/b'
15:03:58.253 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='16e05b91b0072a13967580e9f4eb49979db335b0' to.sha1='<NoInstanceOf_NormalFileDto>'): /1 {11 11ä11#+} 1/b
15:03:58.290 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=6, fromRepositoryId="FileInProgressMarker", toRepositoryId="6", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:58.296 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/1 {11 11ä11#+} 1/b'
15:03:58.463 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:58.479 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 836308 bytes in 182 ms. path='/1 {11 11ä11#+} 1/b'
15:03:58.485 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_e9d71f5ee7c92d6dc9e92ffdad17b8bd49418f98_0 into destFile b
15:03:58.537 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=6, fromRepositoryId="FileInProgressMarker", toRepositoryId="6", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:58.548 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/1 {11 11ä11#+} 1/c'
15:03:58.629 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='d6980b04904e1543c171205bc7fe2e870f3aef2e' to.sha1='<NoInstanceOf_NormalFileDto>'): /1 {11 11ä11#+} 1/c
15:03:58.642 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [63acd7e4]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:58.643 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [63acd7e4]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 469 ms.
15:03:58.660 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=7, fromRepositoryId="FileInProgressMarker", toRepositoryId="7", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:58.667 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/1 {11 11ä11#+} 1/c'
15:03:58.686 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [63acd7e4]getCloseDeferredMillis: closeDeferredMillis=0
15:03:58.686 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [63acd7e4]close: Closing real LocalRepoManager immediately.
15:03:58.686 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [63acd7e4]_close: Shutting down real LocalRepoManager.
15:03:58.731 [main] WARN  c.c.c.l.t.ChangeSetDtoBuilder - prepareLastSyncToRemoteRepo: Enabling resyncMode! lastSyncToRemoteRepoLocalRepositoryRevisionSynced=84 overwrites lastSyncToRemoteRepo.localRepositoryRevisionSynced=89
15:03:58.747 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:03:58.750 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:03:58.750 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:58.750 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:03:58.750 [main] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 remoteRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 localRepositoryRevisionSynced=84 localRepositoryRevisionInProgress=95
15:03:58.762 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:03:58.814 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:03:58.814 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:03:58.814 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:03:58.814 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:03:58.815 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 56.31%
15:03:58.816 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDirectory: path='/3'
15:03:58.833 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 788896 bytes in 165 ms. path='/1 {11 11ä11#+} 1/c'
15:03:58.833 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3646ce69]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:03:58.834 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3646ce69]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:03:58.839 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_84a516841ba77a5b4648de2cd0dfcb30ea46dbb4_0 into destFile c
15:03:58.887 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=7, fromRepositoryId="FileInProgressMarker", toRepositoryId="7", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:58.895 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/2/1 {11 11ä11#+} 1/a'
15:03:58.971 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='f6bbb72a5fd8ff66d38351bd7d61446137876588' to.sha1='<NoInstanceOf_NormalFileDto>'): /2/1 {11 11ä11#+} 1/a
15:03:58.998 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=8, fromRepositoryId="FileInProgressMarker", toRepositoryId="8", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:03:59.002 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/2/1 {11 11ä11#+} 1/a'
15:03:59.084 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:03:59.110 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 529788 bytes in 108 ms. path='/2/1 {11 11ä11#+} 1/a'
15:03:59.118 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_86f7e437faa5a7fce15d1ddcb9eaeaea377667b8_0 into destFile a
15:03:59.263 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3646ce69]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:03:59.263 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3646ce69]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 428 ms.
15:03:59.299 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3646ce69]getCloseDeferredMillis: closeDeferredMillis=0
15:03:59.299 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3646ce69]close: Closing real LocalRepoManager immediately.
15:03:59.299 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3646ce69]_close: Shutting down real LocalRepoManager.
15:04:00.088 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=8, fromRepositoryId="FileInProgressMarker", toRepositoryId="8", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:00.184 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/2/1 {11 11ä11#+} 1/b'
15:04:00.238 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='cfa5f36a4eeaa9fc92fc54e966418e8f61ca6dda' to.sha1='<NoInstanceOf_NormalFileDto>'): /2/1 {11 11ä11#+} 1/b
15:04:00.304 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=9, fromRepositoryId="FileInProgressMarker", toRepositoryId="9", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:00.321 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/2/1 {11 11ä11#+} 1/b'
15:04:00.414 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [847bd72]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:00.414 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [847bd72]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:00.457 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 643977 bytes in 136 ms. path='/2/1 {11 11ä11#+} 1/b'
15:04:00.467 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_e9d71f5ee7c92d6dc9e92ffdad17b8bd49418f98_0 into destFile b
15:04:00.513 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=9, fromRepositoryId="FileInProgressMarker", toRepositoryId="9", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:00.586 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/2/a'
15:04:00.639 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='dfbaaa7685e99363fbc6106aa5e2184ef734b33c' to.sha1='<NoInstanceOf_NormalFileDto>'): /2/a
15:04:00.678 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=10, fromRepositoryId="FileInProgressMarker", toRepositoryId="10", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:00.726 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:00.744 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/2/a'
15:04:00.871 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 267994 bytes in 126 ms. path='/2/a'
15:04:00.882 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_86f7e437faa5a7fce15d1ddcb9eaeaea377667b8_0 into destFile a
15:04:00.926 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=10, fromRepositoryId="FileInProgressMarker", toRepositoryId="10", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:00.936 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/a'
15:04:00.957 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [847bd72]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:00.958 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [847bd72]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 542 ms.
15:04:00.990 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='bcacaa21205ea87456ab9f3c3ab71f3cae356df9' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/a
15:04:01.015 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=11, fromRepositoryId="FileInProgressMarker", toRepositoryId="11", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:01.019 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/a'
15:04:01.101 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [847bd72]getCloseDeferredMillis: closeDeferredMillis=0
15:04:01.101 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [847bd72]close: Closing real LocalRepoManager immediately.
15:04:01.101 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [847bd72]_close: Shutting down real LocalRepoManager.
15:04:01.117 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 112955 bytes in 96 ms. path='/3/a'
15:04:01.127 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_86f7e437faa5a7fce15d1ddcb9eaeaea377667b8_0 into destFile a
15:04:01.145 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 62.42%
15:04:01.146 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 68.52%
15:04:01.146 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/zzz'
15:04:01.175 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=11, fromRepositoryId="FileInProgressMarker", toRepositoryId="11", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:01.190 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/b'
15:04:01.217 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [24ed83fc]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:01.217 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [24ed83fc]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:01.253 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='bd2cdc6679c5fda7bfc12f8b701f662e7832c61a' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/b
15:04:01.283 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=12, fromRepositoryId="FileInProgressMarker", toRepositoryId="12", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:01.289 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/b'
15:04:01.468 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 753800 bytes in 179 ms. path='/3/b'
15:04:01.476 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_e9d71f5ee7c92d6dc9e92ffdad17b8bd49418f98_0 into destFile b
15:04:01.564 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=12, fromRepositoryId="FileInProgressMarker", toRepositoryId="12", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:01.574 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/c'
15:04:01.587 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:01.621 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='415dce8b61861eec55e911f815b5d3d86e5fc65e' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/c
15:04:01.647 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=13, fromRepositoryId="FileInProgressMarker", toRepositoryId="13", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:01.651 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/c'
15:04:01.715 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 238328 bytes in 64 ms. path='/3/c'
15:04:01.717 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [24ed83fc]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:01.718 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [24ed83fc]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 499 ms.
15:04:01.723 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_84a516841ba77a5b4648de2cd0dfcb30ea46dbb4_0 into destFile c
15:04:01.747 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [24ed83fc]getCloseDeferredMillis: closeDeferredMillis=0
15:04:01.747 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [24ed83fc]close: Closing real LocalRepoManager immediately.
15:04:01.747 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [24ed83fc]_close: Shutting down real LocalRepoManager.
15:04:01.753 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=13, fromRepositoryId="FileInProgressMarker", toRepositoryId="13", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:01.765 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/3/d'
15:04:01.780 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7dce2446]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:01.781 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7dce2446]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:01.832 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='c96abba1fd9d1077924cc306ce477751017abb7c' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/d
15:04:01.859 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=14, fromRepositoryId="FileInProgressMarker", toRepositoryId="14", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:01.866 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/d'
15:04:01.985 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 596324 bytes in 119 ms. path='/3/d'
15:04:01.993 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_3c363836cf4e16666669a25da280a1865c2d2874_0 into destFile d
15:04:02.038 [pool-4-thread-1] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:02.041 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=14, fromRepositoryId="FileInProgressMarker", toRepositoryId="14", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:02.051 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 44.48%
15:04:02.051 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncFile: path='/5#/e'
15:04:02.111 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='9c838a637c5341987de92f7da8d4943889721711' to.sha1='<NoInstanceOf_NormalFileDto>'): /5#/e
15:04:02.124 [closeDeferredTimer-2f3d5cd-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2f3d5cd]_close: Shutting down real LocalRepoManager.
15:04:02.126 [closeDeferredTimer-452d6fd-1] INFO  c.c.c.l.LocalRepoManagerImpl - [452d6fd]_close: Shutting down real LocalRepoManager.
15:04:02.141 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=15, fromRepositoryId="FileInProgressMarker", toRepositoryId="15", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:02.146 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/5#/e'
15:04:02.221 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7dce2446]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:02.221 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7dce2446]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 439 ms.
15:04:02.267 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7dce2446]getCloseDeferredMillis: closeDeferredMillis=0
15:04:02.267 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7dce2446]close: Closing real LocalRepoManager immediately.
15:04:02.267 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [7dce2446]_close: Shutting down real LocalRepoManager.
15:04:02.290 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 554132 bytes in 144 ms. path='/5#/e'
15:04:02.297 [main] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_58e6b3a414a1e090dfc6029add0f3555ccba127f_0 into destFile e
15:04:02.537 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=15, fromRepositoryId="FileInProgressMarker", toRepositoryId="15", path="82c730b0-6d77-4ff3-9b8f-43aa33c0c611"] on repo=1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:02.563 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 49.75%
15:04:02.638 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 remoteRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a localRepositoryRevisionSynced=3
15:04:02.679 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a remoteRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 transaction.localRevision=84 remoteFromLocalRevision=3
15:04:02.716 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncUp: fromID=1474cc91-54f7-44a8-a488-822fd0c9cd7a from='target/repo/k8zx2yi7-ojp6d-local' toID=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 to='https://localhost:13393/82c730b0-6d77-4ff3-9b8f-43aa33c0c611'
15:04:02.724 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Beginning to copy file (from.sha1='fb6434b2a678151efd8008d801a6d35c6e4347c2' to.sha1='<NoInstanceOf_NormalFileDto>'): /3/zzz
Apr 14, 2020 3:04:02 PM org.glassfish.jersey.client.JerseyInvocation validateHttpMethodAndEntity
WARNING: Entity must not be null for http method PUT.
15:04:02.737 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [7fc5c41]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:02.738 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [7fc5c41]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:02.822 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:04:02.826 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: 1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:02.826 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: 82c730b0-6d77-4ff3-9b8f-43aa33c0c611
15:04:02.826 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:04:02.826 [main] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a remoteRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 localRepositoryRevisionSynced=-1 localRepositoryRevisionInProgress=84
15:04:02.835 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:04:02.847 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:04:02.848 [main] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:04:02.848 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:04:02.848 [main] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:04:02.849 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 63.43%
15:04:02.849 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 74.63%
15:04:02.875 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a remoteRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 localRepositoryRevisionSynced=84
15:04:02.915 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 remoteRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a transaction.localRevision=6 remoteFromLocalRevision=84
15:04:02.984 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 from='https://localhost:13393/82c730b0-6d77-4ff3-9b8f-43aa33c0c611' toID=1474cc91-54f7-44a8-a488-822fd0c9cd7a to='target/repo/k8zx2yi7-ojp6d-local', fromRepoLocalSync=false
15:04:02.985 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi7-ojp6d-local/.cloudstore-repo/tmp/ChangeSetDto.82c730b0-6d77-4ff3-9b8f-43aa33c0c611.null.xml.gz
15:04:03.065 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:04:03.068 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: 82c730b0-6d77-4ff3-9b8f-43aa33c0c611
15:04:03.068 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: 1474cc91-54f7-44a8-a488-822fd0c9cd7a
15:04:03.068 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:04:03.068 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 remoteRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a localRepositoryRevisionSynced=3 localRepositoryRevisionInProgress=6
15:04:03.070 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:04:03.071 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:04:03.071 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:04:03.071 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:04:03.071 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:04:03.082 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx2yi7-ojp6d-local/.cloudstore-repo/tmp/ChangeSetDto.82c730b0-6d77-4ff3-9b8f-43aa33c0c611.null.xml.gz
15:04:03.082 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 88.31%
15:04:03.082 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 99.50%
15:04:03.097 [qtp831781074-28] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 remoteRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a localRepositoryRevisionSynced=6
15:04:03.151 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=1474cc91-54f7-44a8-a488-822fd0c9cd7a remoteRepositoryId=82c730b0-6d77-4ff3-9b8f-43aa33c0c611 transaction.localRevision=87 remoteFromLocalRevision=6
15:04:03.165 [main] INFO  c.c.c.t.r.AbstractRepoToRepoSyncIT - Synchronising...: 100.00%
15:04:03.334 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [3b26afbc]getCloseDeferredMillis: closeDeferredMillis=20000
15:04:03.335 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [3b26afbc]close: Deferring shut down of real LocalRepoManager 20000 ms.
15:04:03.338 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [23ac164d]getCloseDeferredMillis: closeDeferredMillis=20000
15:04:03.338 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [23ac164d]close: Deferring shut down of real LocalRepoManager 20000 ms.
[INFO] Tests run: 4, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 183.95 s - in co.codewizards.cloudstore.test.repotorepo.BasicRepoToRepoSyncIT
15:04:03.370 [Thread-3] INFO  o.e.j.s.AbstractConnector - Stopped ServerConnector@756aecc7{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
15:04:03.370 [Thread-3] INFO  o.e.j.s.session - node0 Stopped scavenging
15:04:03.380 [Thread-3] INFO  o.e.j.s.h.ContextHandler - Stopped o.e.j.s.ServletContextHandler@769fcb3f{/,null,UNAVAILABLE}
15:04:03.387 [Thread-3] INFO  c.c.c.l.s.LocalServer - onStopOrFailure: File did not exist (could not delete): /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/jvm/U3ypZP7m4q8326s79-SoXQ/.cloudstore/localServerRunning.deleteToStop
15:04:03.396 [Thread-3] INFO  o.e.j.s.AbstractConnector - Stopped ServerConnector@49a0247e{SSL,[ssl, http/1.1]}{0.0.0.0:13393}
15:04:03.396 [Thread-3] INFO  o.e.j.s.session - node0 Stopped scavenging
15:04:03.400 [Thread-3] INFO  o.e.j.s.h.ContextHandler - Stopped o.e.j.s.ServletContextHandler@7bd4a1bc{/,null,UNAVAILABLE}
15:04:03.442 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:03.565 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [7fc5c41]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:03.566 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [7fc5c41]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 827 ms.
15:04:03.592 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [7fc5c41]getCloseDeferredMillis: closeDeferredMillis=0
15:04:03.593 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [7fc5c41]close: Closing real LocalRepoManager immediately.
15:04:03.593 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [7fc5c41]_close: Shutting down real LocalRepoManager.
15:04:03.624 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3b984c4a]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:03.625 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3b984c4a]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:03.851 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:03.973 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3b984c4a]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:03.974 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3b984c4a]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 347 ms.
15:04:04.089 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3b984c4a]getCloseDeferredMillis: closeDeferredMillis=0
15:04:04.090 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3b984c4a]close: Closing real LocalRepoManager immediately.
15:04:04.090 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [3b984c4a]_close: Shutting down real LocalRepoManager.
15:04:05.970 [main] INFO  c.c.c.l.t.FileRepoTransport - Storing fileInProgressMarker: FileInProgressMarker[id=17, fromRepositoryId="FileInProgressMarker", toRepositoryId="17", path="b15c81a8-9fa6-46b0-9d89-13455c2ec1f1"] on repo=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:04:05.976 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Need to copy 1 dirty file-chunks (of 1 total). path='/3/zzz'
15:04:06.020 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1764aed5]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:06.020 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1764aed5]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:06.231 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:06.367 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1764aed5]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:06.367 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1764aed5]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 346 ms.
15:04:06.393 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1764aed5]getCloseDeferredMillis: closeDeferredMillis=0
15:04:06.393 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1764aed5]close: Closing real LocalRepoManager immediately.
15:04:06.393 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1764aed5]_close: Shutting down real LocalRepoManager.
15:04:06.422 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [2cd45ffd]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:06.422 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [2cd45ffd]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:06.632 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:06.765 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [2cd45ffd]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:06.765 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [2cd45ffd]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 342 ms.
15:04:06.811 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [2cd45ffd]getCloseDeferredMillis: closeDeferredMillis=0
15:04:06.811 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [2cd45ffd]close: Closing real LocalRepoManager immediately.
15:04:06.811 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [2cd45ffd]_close: Shutting down real LocalRepoManager.
15:04:06.842 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - Copied 1 dirty file-chunks with together 187220 bytes in 866 ms. path='/3/zzz'
Apr 14, 2020 3:04:06 PM org.glassfish.jersey.client.JerseyInvocation validateHttpMethodAndEntity
WARNING: Entity must not be null for http method PUT.
15:04:06.857 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [59172d89]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:06.858 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [59172d89]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:07.084 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:07.206 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [59172d89]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:07.207 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [59172d89]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 347 ms.
15:04:07.233 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [59172d89]getCloseDeferredMillis: closeDeferredMillis=0
15:04:07.233 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [59172d89]close: Closing real LocalRepoManager immediately.
15:04:07.233 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [59172d89]_close: Shutting down real LocalRepoManager.
15:04:07.274 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [79fe3bbd]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:07.274 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [79fe3bbd]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:07.468 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:07.591 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [79fe3bbd]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:07.592 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [79fe3bbd]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 316 ms.
15:04:07.673 [qtp952533674-33] INFO  c.c.c.l.t.FileRepoTransport - endPutFile: writing tempChunkFile chunk_40fa37ec00c761c7dbb6ebdee6d4a260b922f5f4_0 into destFile zzz
15:04:07.757 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [79fe3bbd]getCloseDeferredMillis: closeDeferredMillis=0
15:04:07.757 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [79fe3bbd]close: Closing real LocalRepoManager immediately.
15:04:07.757 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [79fe3bbd]_close: Shutting down real LocalRepoManager.
15:04:07.820 [main] INFO  c.c.c.l.t.FileRepoTransport - Removing fileInProgressMarker: FileInProgressMarker[id=17, fromRepositoryId="FileInProgressMarker", toRepositoryId="17", path="b15c81a8-9fa6-46b0-9d89-13455c2ec1f1"] on repo=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:04:07.833 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 72.59%
15:04:07.844 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 remoteRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 localRepositoryRevisionSynced=95
15:04:07.858 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1c022de]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:07.858 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1c022de]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:08.042 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:08.168 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1c022de]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:08.169 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1c022de]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 310 ms.
15:04:08.195 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1c022de]getCloseDeferredMillis: closeDeferredMillis=0
15:04:08.195 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1c022de]close: Closing real LocalRepoManager immediately.
15:04:08.195 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [1c022de]_close: Shutting down real LocalRepoManager.
15:04:08.236 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7c04efbe]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:08.237 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7c04efbe]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:08.435 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:08.564 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7c04efbe]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:08.564 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7c04efbe]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 325 ms.
15:04:08.624 [qtp952533674-30] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 transaction.localRevision=15 remoteFromLocalRevision=95
15:04:08.633 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7c04efbe]getCloseDeferredMillis: closeDeferredMillis=0
15:04:08.633 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7c04efbe]close: Closing real LocalRepoManager immediately.
15:04:08.633 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [7c04efbe]_close: Shutting down real LocalRepoManager.
15:04:08.670 [main] INFO  c.c.c.c.r.s.RepoToRepoSync - syncDown: fromID=eb8fbfb3-b3da-4096-b139-355105b7c3e0 from='https://localhost:3541/eb8fbfb3-b3da-4096-b139-355105b7c3e0' toID=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 to='target/repo/k8zx21al-4t1mi-local', fromRepoLocalSync=false
15:04:08.671 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: ChangeSetDto-cache-file NOT found: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local/.cloudstore-repo/tmp/ChangeSetDto.eb8fbfb3-b3da-4096-b139-355105b7c3e0.null.xml.gz
15:04:08.677 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [184cc730]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:08.678 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [184cc730]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:08.900 [qtp952533674-33] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:09.025 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [184cc730]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:09.026 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [184cc730]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 347 ms.
15:04:09.052 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [184cc730]getCloseDeferredMillis: closeDeferredMillis=0
15:04:09.052 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [184cc730]close: Closing real LocalRepoManager immediately.
15:04:09.052 [qtp952533674-33] INFO  c.c.c.l.LocalRepoManagerImpl - [184cc730]_close: Shutting down real LocalRepoManager.
15:04:09.131 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2e4c44a8]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:09.134 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2e4c44a8]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:09.381 [pool-4-thread-1] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:09.542 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2e4c44a8]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:09.543 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2e4c44a8]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 407 ms.
15:04:09.629 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildChangeSetDto >>>
15:04:09.636 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - localRepositoryId: eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:09.636 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - remoteRepositoryId: b15c81a8-9fa6-46b0-9d89-13455c2ec1f1
15:04:09.637 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - pathPrefix: 
15:04:09.637 [pool-4-thread-1] INFO  c.c.c.l.t.ChangeSetDtoBuilder - buildChangeSetDto: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 localRepositoryRevisionSynced=8 localRepositoryRevisionInProgress=15
15:04:09.650 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - toModificationDtos: Creating 0 ModificationDtos took 0 ms.
15:04:09.657 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - >>> buildConfigPropSetDto >>>
15:04:09.657 [pool-4-thread-1] DEBUG c.c.c.l.t.ChangeSetDtoBuilder - buildConfigPropSetDto: pathPrefix is empty => returning null.
15:04:09.658 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildConfigPropSetDto <<< null
15:04:09.658 [pool-4-thread-1] TRACE c.c.c.l.t.ChangeSetDtoBuilder - <<< buildChangeSetDto <<<
15:04:09.658 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2e4c44a8]getCloseDeferredMillis: closeDeferredMillis=0
15:04:09.658 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2e4c44a8]close: Closing real LocalRepoManager immediately.
15:04:09.658 [pool-4-thread-1] INFO  c.c.c.l.LocalRepoManagerImpl - [2e4c44a8]_close: Shutting down real LocalRepoManager.
15:04:10.576 [main] INFO  c.c.c.r.c.t.RestRepoTransport - getChangeSetDto: Wrote ChangeSetDto-cache-file: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21al-4t1mi-local/.cloudstore-repo/tmp/ChangeSetDto.eb8fbfb3-b3da-4096-b139-355105b7c3e0.null.xml.gz
15:04:10.577 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 88.31%
15:04:10.577 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 99.50%
15:04:10.586 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [66f7eeab]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:10.587 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [66f7eeab]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:10.833 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:10.983 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [66f7eeab]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:10.983 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [66f7eeab]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 395 ms.
15:04:11.014 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [66f7eeab]getCloseDeferredMillis: closeDeferredMillis=0
15:04:11.014 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [66f7eeab]close: Closing real LocalRepoManager immediately.
15:04:11.015 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [66f7eeab]_close: Shutting down real LocalRepoManager.
15:04:11.079 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [53dc2fc0]<init>: localRoot='/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote'
15:04:11.080 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [53dc2fc0]initLockFile: Repository '/home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/repo/k8zx21am-ado5-remote' locked successfully.
15:04:11.295 [qtp952533674-30] WARN  D.D.Schema - Retrieved ForeignKey from datastore for table="repository" referencing table repofile but not found internally. Is there some catalog/schema or quoting causing problems?
15:04:11.425 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [53dc2fc0]initPersistenceManagerFactory: repositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0
15:04:11.426 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [53dc2fc0]initPersistenceManagerFactory: Started up PersistenceManagerFactory successfully in 344 ms.
15:04:11.509 [qtp952533674-30] INFO  c.c.c.l.t.FileRepoTransport - endSyncFromRepository: localRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 remoteRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 localRepositoryRevisionSynced=15
15:04:11.511 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [53dc2fc0]getCloseDeferredMillis: closeDeferredMillis=0
15:04:11.512 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [53dc2fc0]close: Closing real LocalRepoManager immediately.
15:04:11.512 [qtp952533674-30] INFO  c.c.c.l.LocalRepoManagerImpl - [53dc2fc0]_close: Shutting down real LocalRepoManager.
15:04:11.573 [main] INFO  c.c.c.l.t.FileRepoTransport - endSyncToRepository: localRepositoryId=b15c81a8-9fa6-46b0-9d89-13455c2ec1f1 remoteRepositoryId=eb8fbfb3-b3da-4096-b139-355105b7c3e0 transaction.localRevision=100 remoteFromLocalRevision=15
15:04:11.577 [main] INFO  c.c.c.t.r.BackupRestoreRepoToRepoSyncIT - Synchronising...: 100.00%
15:04:11.608 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [5702e6f3]getCloseDeferredMillis: closeDeferredMillis=0
15:04:11.608 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [5702e6f3]close: Closing real LocalRepoManager immediately.
15:04:11.608 [main] INFO  c.c.c.l.LocalRepoManagerImpl - [5702e6f3]_close: Shutting down real LocalRepoManager.
[INFO] Tests run: 2, Failures: 0, Errors: 0, Skipped: 0, Time elapsed: 248.011 s - in co.codewizards.cloudstore.test.repotorepo.BackupRestoreRepoToRepoSyncIT
15:04:11.731 [Thread-3] INFO  o.e.j.s.AbstractConnector - Stopped ServerConnector@3e53eda2{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
15:04:11.731 [Thread-3] INFO  o.e.j.s.session - node0 Stopped scavenging
15:04:11.743 [Thread-3] INFO  o.e.j.s.h.ContextHandler - Stopped o.e.j.s.ServletContextHandler@48031395{/,null,UNAVAILABLE}
15:04:11.750 [Thread-3] INFO  c.c.c.l.s.LocalServer - onStopOrFailure: File did not exist (could not delete): /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/jvm/qK7nmwS1XjG1FD01zfJcbQ/.cloudstore/localServerRunning.deleteToStop
15:04:11.754 [Thread-3] INFO  o.e.j.s.AbstractConnector - Stopped ServerConnector@4d086d6c{SSL,[ssl, http/1.1]}{0.0.0.0:3541}
15:04:11.755 [Thread-3] INFO  o.e.j.s.session - node0 Stopped scavenging
15:04:11.759 [Thread-3] INFO  o.e.j.s.h.ContextHandler - Stopped o.e.j.s.ServletContextHandler@1a43b23d{/,null,UNAVAILABLE}
15:04:29.080 [main] ERROR c.c.c.r.c.CloudStoreRestClient - determineBaseUrl: Determining baseURL failed for hostURL='https://localhost:2127/': javax.ws.rs.ProcessingException: javax.net.ssl.SSLException: readHandshakeRecord
15:04:29.081 [main] WARN  c.c.c.r.c.CloudStoreRestClient - execute: invocation failed (will retry): javax.ws.rs.ProcessingException: Determining baseURL failed for hostURL='https://localhost:2127/': javax.ws.rs.ProcessingException: javax.net.ssl.SSLException: readHandshakeRecord
javax.ws.rs.ProcessingException: Determining baseURL failed for hostURL='https://localhost:2127/': javax.ws.rs.ProcessingException: javax.net.ssl.SSLException: readHandshakeRecord
	at co.codewizards.cloudstore.rest.client.CloudStoreRestClient.determineBaseUrl(CloudStoreRestClient.java:130)
	at co.codewizards.cloudstore.rest.client.CloudStoreRestClient.getBaseUrl(CloudStoreRestClient.java:75)
	at co.codewizards.cloudstore.rest.client.request.AbstractRequest.getBaseURL(AbstractRequest.java:146)
	at co.codewizards.cloudstore.rest.client.request.AbstractRequest.createWebTarget(AbstractRequest.java:115)
	at co.codewizards.cloudstore.rest.client.request.TestRequest.execute(TestRequest.java:27)
	at co.codewizards.cloudstore.rest.client.request.TestRequest.execute(TestRequest.java:6)
	at co.codewizards.cloudstore.rest.client.CloudStoreRestClient.execute(CloudStoreRestClient.java:175)
	at co.codewizards.cloudstore.test.CertificateHandlingAndTestServiceLRT.almostTimedOut_5min(CertificateHandlingAndTestServiceLRT.java:89)
	at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
	at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:62)
	at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43)
	at java.base/java.lang.reflect.Method.invoke(Method.java:566)
	at org.junit.runners.model.FrameworkMethod$1.runReflectiveCall(FrameworkMethod.java:50)
	at org.junit.internal.runners.model.ReflectiveCallable.run(ReflectiveCallable.java:12)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java:47)
	at mockit.integration.junit4.internal.JUnit4TestRunnerDecorator.executeTestMethod(JUnit4TestRunnerDecorator.java:156)
	at mockit.integration.junit4.internal.JUnit4TestRunnerDecorator.invokeExplosively(JUnit4TestRunnerDecorator.java:65)
	at mockit.integration.junit4.internal.MockFrameworkMethod.invokeExplosively(MockFrameworkMethod.java:37)
	at org.junit.runners.model.FrameworkMethod.invokeExplosively(FrameworkMethod.java)
	at org.junit.internal.runners.statements.InvokeMethod.evaluate(InvokeMethod.java:17)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.runLeaf(ParentRunner.java:325)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:78)
	at org.junit.runners.BlockJUnit4ClassRunner.runChild(BlockJUnit4ClassRunner.java:57)
	at org.junit.runners.ParentRunner$3.run(ParentRunner.java:290)
	at org.junit.runners.ParentRunner$1.schedule(ParentRunner.java:71)
	at org.junit.runners.ParentRunner.runChildren(ParentRunner.java:288)
	at org.junit.runners.ParentRunner.access$000(ParentRunner.java:58)
	at org.junit.runners.ParentRunner$2.evaluate(ParentRunner.java:268)
	at org.junit.internal.runners.statements.RunBefores.evaluate(RunBefores.java:26)
	at org.junit.internal.runners.statements.RunAfters.evaluate(RunAfters.java:27)
	at org.junit.runners.ParentRunner.run(ParentRunner.java:363)
	at org.apache.maven.surefire.junit4.JUnit4Provider.execute(JUnit4Provider.java:365)
	at org.apache.maven.surefire.junit4.JUnit4Provider.executeWithRerun(JUnit4Provider.java:273)
	at org.apache.maven.surefire.junit4.JUnit4Provider.executeTestSet(JUnit4Provider.java:238)
	at org.apache.maven.surefire.junit4.JUnit4Provider.invoke(JUnit4Provider.java:159)
	at org.apache.maven.surefire.booter.ForkedBooter.runSuitesInProcess(ForkedBooter.java:377)
	at org.apache.maven.surefire.booter.ForkedBooter.execute(ForkedBooter.java:138)
	at org.apache.maven.surefire.booter.ForkedBooter.run(ForkedBooter.java:465)
	at org.apache.maven.surefire.booter.ForkedBooter.main(ForkedBooter.java:451)
Caused by: javax.ws.rs.ProcessingException: javax.net.ssl.SSLException: readHandshakeRecord
	at org.glassfish.jersey.client.internal.HttpUrlConnector.apply(HttpUrlConnector.java:260)
	at org.glassfish.jersey.client.ClientRuntime.invoke(ClientRuntime.java:254)
	at org.glassfish.jersey.client.JerseyInvocation.lambda$invoke$1(JerseyInvocation.java:750)
	at org.glassfish.jersey.internal.Errors.process(Errors.java:292)
	at org.glassfish.jersey.internal.Errors.process(Errors.java:274)
	at org.glassfish.jersey.internal.Errors.process(Errors.java:205)
	at org.glassfish.jersey.process.internal.RequestScope.runInScope(RequestScope.java:390)
	at org.glassfish.jersey.client.JerseyInvocation.invoke(JerseyInvocation.java:748)
	at org.glassfish.jersey.client.JerseyInvocation$Builder.method(JerseyInvocation.java:404)
	at org.glassfish.jersey.client.JerseyInvocation$Builder.get(JerseyInvocation.java:300)
	at co.codewizards.cloudstore.rest.client.CloudStoreRestClient.determineBaseUrl(CloudStoreRestClient.java:118)
	... 40 common frames omitted
Caused by: javax.net.ssl.SSLException: readHandshakeRecord
	at java.base/sun.security.ssl.SSLSocketImpl.readHandshakeRecord(SSLSocketImpl.java:1071)
	at java.base/sun.security.ssl.SSLSocketImpl.startHandshake(SSLSocketImpl.java:402)
	at java.base/sun.net.www.protocol.https.HttpsClient.afterConnect(HttpsClient.java:567)
	at java.base/sun.net.www.protocol.https.AbstractDelegateHttpsURLConnection.connect(AbstractDelegateHttpsURLConnection.java:185)
	at java.base/sun.net.www.protocol.http.HttpURLConnection.getInputStream0(HttpURLConnection.java:1587)
	at java.base/sun.net.www.protocol.http.HttpURLConnection.getInputStream(HttpURLConnection.java:1515)
	at java.base/java.net.HttpURLConnection.getResponseCode(HttpURLConnection.java:527)
	at java.base/sun.net.www.protocol.https.HttpsURLConnectionImpl.getResponseCode(HttpsURLConnectionImpl.java:334)
	at org.glassfish.jersey.client.internal.HttpUrlConnector._apply(HttpUrlConnector.java:366)
	at org.glassfish.jersey.client.internal.HttpUrlConnector.apply(HttpUrlConnector.java:258)
	... 50 common frames omitted
	Suppressed: java.net.SocketException: Broken pipe (Write failed)
		at java.base/java.net.SocketOutputStream.socketWrite0(Native Method)
		at java.base/java.net.SocketOutputStream.socketWrite(SocketOutputStream.java:110)
		at java.base/java.net.SocketOutputStream.write(SocketOutputStream.java:150)
		at java.base/sun.security.ssl.SSLSocketOutputRecord.encodeAlert(SSLSocketOutputRecord.java:81)
		at java.base/sun.security.ssl.TransportContext.fatal(TransportContext.java:351)
		at java.base/sun.security.ssl.TransportContext.fatal(TransportContext.java:263)
		at java.base/sun.security.ssl.SSLSocketImpl.startHandshake(SSLSocketImpl.java:405)
		... 58 common frames omitted
Caused by: java.net.SocketException: Broken pipe (Write failed)
	at java.base/java.net.SocketOutputStream.socketWrite0(Native Method)
	at java.base/java.net.SocketOutputStream.socketWrite(SocketOutputStream.java:110)
	at java.base/java.net.SocketOutputStream.write(SocketOutputStream.java:150)
	at java.base/sun.security.ssl.SSLSocketOutputRecord.encodeChangeCipherSpec(SSLSocketOutputRecord.java:221)
	at java.base/sun.security.ssl.OutputRecord.changeWriteCiphers(OutputRecord.java:162)
	at java.base/sun.security.ssl.ChangeCipherSpec$T10ChangeCipherSpecProducer.produce(ChangeCipherSpec.java:118)
	at java.base/sun.security.ssl.Finished$T12FinishedProducer.onProduceFinished(Finished.java:395)
	at java.base/sun.security.ssl.Finished$T12FinishedProducer.produce(Finished.java:379)
	at java.base/sun.security.ssl.SSLHandshake.produce(SSLHandshake.java:436)
	at java.base/sun.security.ssl.ServerHelloDone$ServerHelloDoneConsumer.consume(ServerHelloDone.java:182)
	at java.base/sun.security.ssl.SSLHandshake.consume(SSLHandshake.java:392)
	at java.base/sun.security.ssl.HandshakeContext.dispatch(HandshakeContext.java:443)
	at java.base/sun.security.ssl.HandshakeContext.dispatch(HandshakeContext.java:421)
	at java.base/sun.security.ssl.TransportContext.dispatch(TransportContext.java:177)
	at java.base/sun.security.ssl.SSLTransport.decode(SSLTransport.java:164)
	at java.base/sun.security.ssl.SSLSocketImpl.decode(SSLSocketImpl.java:1151)
	at java.base/sun.security.ssl.SSLSocketImpl.readHandshakeRecord(SSLSocketImpl.java:1062)
	... 59 common frames omitted
[WARNING] Tests run: 4, Failures: 0, Errors: 0, Skipped: 1, Time elapsed: 434.543 s - in co.codewizards.cloudstore.test.CertificateHandlingAndTestServiceLRT
15:04:30.354 [Thread-3] INFO  o.e.j.s.AbstractConnector - Stopped ServerConnector@5aaf7a8e{HTTP/1.1,[http/1.1]}{127.0.0.1:0}
15:04:30.355 [Thread-3] INFO  o.e.j.s.session - node0 Stopped scavenging
15:04:30.390 [Thread-3] INFO  o.e.j.s.h.ContextHandler - Stopped o.e.j.s.ServletContextHandler@6a0231e2{/,null,UNAVAILABLE}
15:04:30.397 [Thread-3] INFO  c.c.c.l.s.LocalServer - onStopOrFailure: File did not exist (could not delete): /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/jvm/l0afN0b0LiiDF5oEcSBzoQ/.cloudstore/localServerRunning.deleteToStop
15:04:30.430 [Thread-3] INFO  o.e.j.s.AbstractConnector - Stopped ServerConnector@17caf44c{SSL,[ssl, http/1.1]}{0.0.0.0:2127}
15:04:30.431 [Thread-3] INFO  o.e.j.s.session - node0 Stopped scavenging
15:04:30.443 [Thread-3] INFO  o.e.j.s.h.ContextHandler - Stopped o.e.j.s.ServletContextHandler@1623b416{/,null,UNAVAILABLE}
[INFO] 
[INFO] Results:
[INFO] 
[WARNING] Tests run: 52, Failures: 0, Errors: 0, Skipped: 1
[INFO] 
[JENKINS] Recording test results
[INFO] 
[INFO] --- maven-source-plugin:3.2.1:jar-no-fork (attach-sources) @ co.codewizards.cloudstore.test ---
[INFO] Building jar: /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/co.codewizards.cloudstore.test-1.0.1-SNAPSHOT-sources.jar
[INFO] 
[INFO] --- maven-failsafe-plugin:3.0.0-M4:verify (default) @ co.codewizards.cloudstore.test ---
[INFO] 
[INFO] --- maven-install-plugin:2.4:install (default-install) @ co.codewizards.cloudstore.test ---
[JENKINS] Recording test results
[INFO] Installing /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/co.codewizards.cloudstore.test-1.0.1-SNAPSHOT.jar to /home/tomcat/.m2/repository/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-SNAPSHOT.jar
[INFO] Installing /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/pom.xml to /home/tomcat/.m2/repository/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-SNAPSHOT.pom
[INFO] Installing /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/co.codewizards.cloudstore.test-1.0.1-SNAPSHOT-sources.jar to /home/tomcat/.m2/repository/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-SNAPSHOT-sources.jar
[INFO] 
[INFO] --- maven-deploy-plugin:2.7:deploy (default-deploy) @ co.codewizards.cloudstore.test ---
[INFO] Downloading from cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/maven-metadata.xml
[INFO] Downloaded from cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/maven-metadata.xml (1.0 kB at 18 kB/s)
[INFO] Uploading to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-20200414.130431-10.jar
[INFO] Uploaded to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-20200414.130431-10.jar (7.3 kB at 7.3 MB/s)
[INFO] Uploading to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-20200414.130431-10.pom
[INFO] Uploaded to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-20200414.130431-10.pom (5.3 kB at 5.3 MB/s)
[INFO] Downloading from cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/maven-metadata.xml
[INFO] Downloaded from cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/maven-metadata.xml (315 B at 105 kB/s)
[INFO] Uploading to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/maven-metadata.xml
[INFO] Uploaded to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/maven-metadata.xml (1.0 kB at 256 kB/s)
[INFO] Uploading to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/maven-metadata.xml
[INFO] Uploaded to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/maven-metadata.xml (315 B at 105 kB/s)
[INFO] Uploading to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-20200414.130431-10-sources.jar
[INFO] Uploaded to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/co.codewizards.cloudstore.test-1.0.1-20200414.130431-10-sources.jar (5.0 kB at 1.7 MB/s)
[INFO] Uploading to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/maven-metadata.xml
[INFO] Uploaded to cloudstore-snapshot-repo: file:/srv/www/nightly/cloudstore.codewizards.co/htdocs/maven/snapshot/co/codewizards/cloudstore/co.codewizards.cloudstore.test/1.0.1-SNAPSHOT/maven-metadata.xml (1.0 kB at 1.0 MB/s)
[INFO] 
[INFO] --- maven-site-plugin:3.3:site (default-site) @ co.codewizards.cloudstore.test ---
[INFO] Relativizing decoration links with respect to project URL: http://cloudstore.codewizards.co/co.codewizards.cloudstore.test
[INFO] Rendering site with org.apache.maven.skins:maven-default-skin:jar:1.0 skin.
[INFO] Relativizing decoration links with respect to project URL: http://cloudstore.codewizards.co/co.codewizards.cloudstore.test/de
[INFO] Rendering site with org.apache.maven.skins:maven-default-skin:jar:1.0 skin.
[JENKINS] Archiving site from /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/site to /home/tomcat/.jenkins/jobs/co.codewizards.cloudstore_java_11/site/co.codewizards.cloudstore.test
[INFO] 
[INFO] >>> maven-javadoc-plugin:3.1.1:javadoc (javadoc-generate-unfiltered) > generate-sources @ co.codewizards.cloudstore.test >>>
[WARNING] Failed to getClass for org.apache.maven.plugins.javadoc.JavadocReport
[JENKINS] Archiving  javadoc
[INFO] 
[INFO] <<< maven-javadoc-plugin:3.1.1:javadoc (javadoc-generate-unfiltered) < generate-sources @ co.codewizards.cloudstore.test <<<
[INFO] 
[INFO] 
[INFO] --- maven-javadoc-plugin:3.1.1:javadoc (javadoc-generate-unfiltered) @ co.codewizards.cloudstore.test ---
[INFO] Skipping javadoc generation
[JENKINS] Archiving  javadoc
[INFO] 
[INFO] --- maven-resources-plugin:2.6:copy-resources (javadoc-filter) @ co.codewizards.cloudstore.test ---
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] skip non existing resourceDirectory /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/javadoc.unfiltered
[INFO] skip non existing resourceDirectory /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/javadoc.unfiltered
[INFO] 
[INFO] --- maven-resources-plugin:2.6:copy-resources (javadoc-copy-to-site) @ co.codewizards.cloudstore.test ---
[INFO] Using 'UTF-8' encoding to copy filtered resources.
[INFO] skip non existing resourceDirectory /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/apidocs
[INFO] 
[INFO] --- maven-site-plugin:3.3:deploy (default-deploy) @ co.codewizards.cloudstore.test ---
file:/tmp/cloudstore-junk/ - Session: Opened  
[INFO] Pushing /home/tomcat/.jenkins/workspace/co.codewizards.cloudstore_java_11/co.codewizards.cloudstore.test/target/site
[INFO]    >>> to file:/tmp/cloudstore-junk/co.codewizards.cloudstore.test
[INFO]    >>> to file:/tmp/cloudstore-junk/de/co.codewizards.cloudstore.test
file:/tmp/cloudstore-junk/ - Session: Disconnecting  
file:/tmp/cloudstore-junk/ - Session: Disconnected