See <https://ci-builds.apache.org/job/Brooklyn/job/brooklyn-server/job/master/514/display/redirect>
Changes: ------------------------------------------ [...truncated 36874 lines...] at org.apache.brooklyn.util.javalang.Reflections.invokeMethodFromArgs(Reflections.java:875) at org.apache.brooklyn.util.javalang.Reflections.invokeMethodFromArgs(Reflections.java:861) at org.apache.brooklyn.util.javalang.Reflections.invokeMethodFromArgs(Reflections.java:856) at org.apache.brooklyn.core.mgmt.internal.AbstractManagementContext.invokeEffectorMethodLocal(AbstractManagementContext.java:334) ... 12 common frames omitted Caused by: java.lang.RuntimeException: wrapping at org.apache.brooklyn.core.entity.trait.FailingEntityImpl.newException(FailingEntityImpl.java:110) at org.apache.brooklyn.core.entity.trait.FailingEntityImpl.fail(FailingEntityImpl.java:102) at org.apache.brooklyn.core.entity.trait.FailingEntityImpl.start(FailingEntityImpl.java:50) ... 20 common frames omitted Caused by: org.apache.brooklyn.api.location.NoMachinesAvailableException: Simulating entity start failure for test at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native Method) at sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAccessorImpl.java:62) at sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstructorAccessorImpl.java:45) at java.lang.reflect.Constructor.newInstance(Constructor.java:423) at org.apache.brooklyn.core.entity.trait.FailingEntityImpl.newException(FailingEntityImpl.java:108) ... 22 common frames omitted 2023-09-15 13:32:32,911 WARN o.a.b.c.e.l.ServiceStateLogic$ComputeServiceState Setting DynamicClusterImpl{id=qosqt2cv0m} on-fire due to problems when expected running, up=true, problems: {service-lifecycle-indicators-from-children-and-members=Required entity not healthy: FailingEntity:ba8m (ba8mlyh10n) (on-fire)} 2023-09-15 13:32:32,911 INFO o.a.b.e.g.DynamicClusterImpl Cluster DynamicClusterImpl{id=qosqt2cv0m} discarding failed node FailingEntityImpl{id=ba8mlyh10n}, rather than quarantining 2023-09-15 13:32:32,911 WARN o.a.b.c.m.i.EffectorUtils Error invoking resize at DynamicClusterImpl{id=qosqt2cv0m}: InsufficientCapacityException: Failed to resize 2023-09-15 13:32:32,913 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testResizeWhereSubsetOfChildrenThrowsNoMachineAvailableExceptionIsPropagatedAsInsuffientCapacityException() finished in 46 ms 2023-09-15 13:32:32,913 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:32,919 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 6 ms 2023-09-15 13:32:32,919 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() 2023-09-15 13:32:32,929 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() finished in 10 ms 2023-09-15 13:32:32,929 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testServiceUpAfterStartingWithNoMembers() 2023-09-15 13:32:32,941 WARN o.a.b.c.l.Locations Deprecated use of unmanaged location (SimulatedLocation{id=yheam1934u, name=SimulatedLocation:yhea}); will be managed automatically now but not supported in future versions 2023-09-15 13:32:32,952 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testServiceUpAfterStartingWithNoMembers() finished in 22 ms 2023-09-15 13:32:32,952 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:32,958 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 6 ms 2023-09-15 13:32:32,958 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() 2023-09-15 13:32:32,970 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() finished in 12 ms 2023-09-15 13:32:32,970 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testUnmanagedChildIsRemoveFromGroup() 2023-09-15 13:32:32,985 WARN o.a.b.c.l.Locations Deprecated use of unmanaged location (SimulatedLocation{id=tx6yehgwup, name=SimulatedLocation:tx6y}); will be managed automatically now but not supported in future versions 2023-09-15 13:32:32,991 INFO o.a.b.e.g.DynamicClusterImpl Resize DynamicClusterImpl{id=t9xn80f4qm} from 0 to 1 2023-09-15 13:32:33,013 WARN o.a.b.c.e.l.ServiceStateLogic$ComputeServiceState Setting DynamicClusterImpl{id=t9xn80f4qm} on-fire due to problems when expected running, up=false, not-up-indicators: {service-not-up-indicators-from-children-and-members=No entities present} 2023-09-15 13:32:33,013 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testUnmanagedChildIsRemoveFromGroup() finished in 43 ms 2023-09-15 13:32:33,013 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:33,017 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 4 ms 2023-09-15 13:32:33,017 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() 2023-09-15 13:32:33,025 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() finished in 8 ms 2023-09-15 13:32:33,026 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWaitForServiceFails() 2023-09-15 13:32:33,046 INFO o.a.b.e.g.DynamicClusterImpl Resize DynamicClusterImpl{id=ij9o6y0c6w} from 0 to 1 2023-09-15 13:32:33,261 WARN o.a.b.c.e.l.ServiceStateLogic Service is not up when setting running on DynamicClusterImpl{id=ij9o6y0c6w}; delayed 201ms but Sensor: service.isUp (java.lang.Boolean) did not recover from false; not-up-indicators={simulateNotUpKey=myVal} 2023-09-15 13:32:33,261 WARN o.a.b.c.e.l.ServiceStateLogic$ComputeServiceState Setting DynamicClusterImpl{id=ij9o6y0c6w} on-fire due to problems when expected running, up=false, not-up-indicators: {simulateNotUpKey=myVal} 2023-09-15 13:32:33,261 WARN o.a.b.c.m.i.EffectorUtils Error invoking start at DynamicClusterImpl{id=ij9o6y0c6w}: Timeout waiting for SERVICE_UP on DynamicClusterImpl{id=ij9o6y0c6w} 2023-09-15 13:32:33,262 WARN o.a.b.c.e.l.ServiceStateLogic$ComputeServiceState Setting Application[unpsir5q] on-fire due to problems when expected running, up=false, problems: {service-lifecycle-indicators-from-children-and-members=Required entity not healthy: Cluster of TestEntity (ij9o6y0c6w) (on-fire)} 2023-09-15 13:32:33,262 WARN o.a.b.c.e.l.ServiceStateLogic$ComputeServiceState Setting Application[unpsir5q] on-fire due to problems when expected running, up=false, problems: {service-lifecycle-indicators-from-children-and-members=Required entity not healthy: Cluster of TestEntity (ij9o6y0c6w) (on-fire)} 2023-09-15 13:32:33,262 WARN o.a.b.c.m.i.EffectorUtils Error invoking start at Application[unpsir5q]: ProblemStartingChildrenException: org.apache.brooklyn.util.exceptions.PropagatedRuntimeException: Error invoking start at DynamicClusterImpl{id=ij9o6y0c6w}: Timeout waiting for SERVICE_UP on DynamicClusterImpl{id=ij9o6y0c6w} 2023-09-15 13:32:33,264 INFO o.a.b.e.g.DynamicClusterTest start-time 227ms 2023-09-15 13:32:33,265 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWaitForServiceFails() finished in 240 ms 2023-09-15 13:32:33,265 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:33,271 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 6 ms 2023-09-15 13:32:33,271 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() 2023-09-15 13:32:33,280 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() finished in 9 ms 2023-09-15 13:32:33,280 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWaitForServiceSucceedsEventually() 2023-09-15 13:32:33,302 INFO o.a.b.e.g.DynamicClusterImpl Resize DynamicClusterImpl{id=qp52b8sec6} from 0 to 1 2023-09-15 13:32:33,455 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWaitForServiceSucceedsEventually() finished in 175 ms 2023-09-15 13:32:33,455 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:33,461 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 6 ms 2023-09-15 13:32:33,462 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() 2023-09-15 13:32:33,472 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() finished in 10 ms 2023-09-15 13:32:33,472 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWaitForServiceUpDefaultsToNotChecking() 2023-09-15 13:32:33,493 INFO o.a.b.e.g.DynamicClusterImpl Resize DynamicClusterImpl{id=nvghdpupat} from 0 to 1 2023-09-15 13:32:33,704 WARN o.a.b.c.e.l.ServiceStateLogic Service is not up when setting running on DynamicClusterImpl{id=nvghdpupat}; delayed 201ms but Sensor: service.isUp (java.lang.Boolean) did not recover from false; not-up-indicators={simulateNotUpKey=myVal} 2023-09-15 13:32:33,704 WARN o.a.b.c.e.l.ServiceStateLogic$ComputeServiceState Setting DynamicClusterImpl{id=nvghdpupat} on-fire due to problems when expected running, up=false, not-up-indicators: {simulateNotUpKey=myVal} 2023-09-15 13:32:33,906 WARN o.a.b.c.e.l.ServiceStateLogic Service is not up when setting running on Application[1mrzz28r]; delayed 201ms but Sensor: service.isUp (java.lang.Boolean) did not recover from false; not-up-indicators={service-lifecycle-indicators-from-children-and-members=DynamicClusterImpl{id=nvghdpupat} is not up} 2023-09-15 13:32:33,906 WARN o.a.b.c.e.l.ServiceStateLogic$ComputeServiceState Setting Application[1mrzz28r] on-fire due to problems when expected running, up=false, problems: {service-lifecycle-indicators-from-children-and-members=Required entity not healthy: Cluster of TestEntity (nvghdpupat) (on-fire)} 2023-09-15 13:32:33,907 INFO o.a.b.e.g.DynamicClusterTest start-time 423ms 2023-09-15 13:32:33,908 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWaitForServiceUpDefaultsToNotChecking() finished in 436 ms 2023-09-15 13:32:33,908 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:33,915 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 7 ms 2023-09-15 13:32:33,915 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() 2023-09-15 13:32:33,925 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() finished in 10 ms 2023-09-15 13:32:33,925 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWithNonStartableEntity() 2023-09-15 13:32:33,944 WARN o.a.b.c.l.Locations Deprecated use of unmanaged location (SimulatedLocation{id=bj2ozjggec, name=SimulatedLocation:bj2o}); will be managed automatically now but not supported in future versions 2023-09-15 13:32:33,955 INFO o.a.b.e.g.DynamicClusterImpl Resize DynamicClusterImpl{id=dun62b4te4} from 0 to 2 2023-09-15 13:32:33,967 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.testWithNonStartableEntity() finished in 42 ms 2023-09-15 13:32:33,967 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:33,973 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 6 ms 2023-09-15 13:32:33,973 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() 2023-09-15 13:32:33,986 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.DynamicClusterTest.setUp() finished in 13 ms 2023-09-15 13:32:33,986 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.usingEntitySpecResizeFromZeroToOneStartsANewEntityAndSetsItsParent() 2023-09-15 13:32:34,005 WARN o.a.b.c.l.Locations Deprecated use of unmanaged location (SimulatedLocation{id=jtcbrqp7g9, name=SimulatedLocation:jtcb}); will be managed automatically now but not supported in future versions 2023-09-15 13:32:34,015 INFO o.a.b.e.g.DynamicClusterImpl Resize DynamicClusterImpl{id=ajdbilvmv2} from 0 to 1 2023-09-15 13:32:34,041 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.DynamicClusterTest.usingEntitySpecResizeFromZeroToOneStartsANewEntityAndSetsItsParent() finished in 55 ms 2023-09-15 13:32:34,041 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() 2023-09-15 13:32:34,047 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.core.test.BrooklynMgmtUnitTestSupport.tearDown() finished in 6 ms 2023-09-15 13:32:34,048 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.SshCommandMembershipTrackingPolicyTest.setUp() [GC (Allocation Failure) 412234K->181946K(772096K), 0.0306262 secs] 2023-09-15 13:32:34,125 INFO o.a.b.e.s.AbstractStartableImpl Starting entity BasicStartableImpl{id=m67zbu8mwm} at [SimulatedLocation{id=epsqeoi75f, name=SimulatedLocation:epsq}] 2023-09-15 13:32:34,136 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @BeforeMethod org.apache.brooklyn.entity.group.SshCommandMembershipTrackingPolicyTest.setUp() finished in 88 ms 2023-09-15 13:32:34,136 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.entity.group.SshCommandMembershipTrackingPolicyTest.testCommandExecutedWithEnvironment() 2023-09-15 13:32:34,148 INFO o.a.b.e.g.SshCommandMembershipTrackingPolicy Executing command on SshMachineLocation[SshMachineLocation:cm4f:null@1.2.3.4/1.2.3.4(id=cm4flyesl0)]: echo ignored 2023-09-15 13:32:34,155 INFO o.a.b.e.g.SshCommandMembershipTrackingPolicy Executing command on SshMachineLocation[SshMachineLocation:cm4f:jenkins@1.2.3.4/1.2.3.4(id=cm4flyesl0)]: echo ignored 2023-09-15 13:32:35,156 INFO o.a.b.e.g.SshCommandMembershipTrackingPolicy Executing command on SshMachineLocation[SshMachineLocation:cm4f:jenkins@1.2.3.4/1.2.3.4(id=cm4flyesl0)]: echo ignored 2023-09-15 13:32:35,159 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.entity.group.SshCommandMembershipTrackingPolicyTest.testCommandExecutedWithEnvironment() finished in 1023 ms 2023-09-15 13:32:35,160 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.entity.group.SshCommandMembershipTrackingPolicyTest.tearDown() 2023-09-15 13:32:35,164 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED CONFIGURATION: "Surefire test" - @AfterMethod org.apache.brooklyn.entity.group.SshCommandMembershipTrackingPolicyTest.tearDown() finished in 4 ms 2023-09-15 13:32:35,366 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG =============================================== Surefire test Tests run: 2705, Failures: 1, Skips: 0 =============================================== [GC (Allocation Failure) 414906K->179282K(771584K), 0.0100759 secs] [GC (Allocation Failure) 412242K->179920K(771584K), 0.0085721 secs] 2023-09-15 13:32:36,576 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG RUNNING: Suite: "Surefire test" containing "0" Tests (config: null) 2023-09-15 13:32:36,652 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithDateTimeTo() 2023-09-15 13:32:36,656 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithDateTimeTo() finished in 11 ms 2023-09-15 13:32:36,656 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithEntityId() 2023-09-15 13:32:36,657 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithEntityId() finished in 12 ms 2023-09-15 13:32:36,657 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithSearchSinglePhrase() 2023-09-15 13:32:36,657 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithSearchSinglePhrase() finished in 12 ms 2023-09-15 13:32:36,657 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithEntityIdAndPhrase() 2023-09-15 13:32:36,657 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithEntityIdAndPhrase() finished in 12 ms 2023-09-15 13:32:36,657 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTaskId() 2023-09-15 13:32:36,658 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTaskId() finished in 13 ms 2023-09-15 13:32:36,658 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTimeRange() 2023-09-15 13:32:36,658 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTimeRange() finished in 13 ms 2023-09-15 13:32:36,658 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTaskIdAndPhrase() 2023-09-15 13:32:36,658 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTaskIdAndPhrase() finished in 13 ms 2023-09-15 13:32:36,658 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTwoLogLevel() 2023-09-15 13:32:36,659 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTwoLogLevel() finished in 14 ms 2023-09-15 13:32:36,660 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithOneLogLevelAndRange() 2023-09-15 13:32:36,660 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithOneLogLevelAndRange() finished in 15 ms 2023-09-15 13:32:36,660 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithDateTimeFrom() 2023-09-15 13:32:36,660 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithDateTimeFrom() finished in 15 ms 2023-09-15 13:32:36,660 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTwoLogLevelAndRange() 2023-09-15 13:32:36,661 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTwoLogLevelAndRange() finished in 16 ms 2023-09-15 13:32:36,661 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG INVOKING: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTailRequest() 2023-09-15 13:32:36,661 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG PASSED: "Surefire test" - org.apache.brooklyn.util.core.logbook.opensearch.OpenSearchLogStoreTest.queryWithTailRequest() finished in 16 ms 2023-09-15 13:32:36,663 INFO o.a.b.t.s.LoggingVerboseReporter TESTNG =============================================== Surefire test Tests run: 12, Failures: 0, Skips: 0 =============================================== Tests run: 2717, Failures: 1, Errors: 0, Skipped: 0, Time elapsed: 267.403 sec <<< FAILURE! - in TestSuite testUnmanagedEntityCanBeGcedEvenIfPreviouslyTagged(org.apache.brooklyn.core.mgmt.internal.EntityExecutionManagerTest) Time elapsed: 30.025 sec <<< FAILURE! java.lang.AssertionError: failed succeeds-eventually, 75 attempts, 30000ms elapsed: AssertionError: tags contains unmanaged entity (wrapped) Wrapped[contextEntity:TestEntityImpl{id=z613gzcswh}]; tasks: [Task[sensor z613gzcswh:service.state.expected]@kx0ew4c9] at org.apache.brooklyn.core.mgmt.internal.EntityExecutionManagerTest.testUnmanagedEntityCanBeGcedEvenIfPreviouslyTagged(EntityExecutionManagerTest.java:371) Caused by: java.lang.AssertionError: tags contains unmanaged entity (wrapped) Wrapped[contextEntity:TestEntityImpl{id=z613gzcswh}]; tasks: [Task[sensor z613gzcswh:service.state.expected]@kx0ew4c9] at org.apache.brooklyn.core.mgmt.internal.EntityExecutionManagerTest.lambda$testUnmanagedEntityCanBeGcedEvenIfPreviouslyTagged$1(EntityExecutionManagerTest.java:379) at org.apache.brooklyn.core.mgmt.internal.EntityExecutionManagerTest.testUnmanagedEntityCanBeGcedEvenIfPreviouslyTagged(EntityExecutionManagerTest.java:371) 2023-09-15 13:32:36,716 INFO o.a.b.c.m.i.BrooklynShutdownHooks Brooklyn shutdown: stopping entities [TestEntityImpl{id=hc4jdxa1j7}, TestEntityImpl{id=n1oagsgl8z}, BlockingEntityImpl{id=b4rlvchggj}] Results : Failed tests: EntityExecutionManagerTest.testUnmanagedEntityCanBeGcedEvenIfPreviouslyTagged:371 failed succeeds-eventually, 75 attempts, 30000ms elapsed: AssertionError: tags contains unmanaged entity (wrapped) Wrapped[contextEntity:TestEntityImpl{id=z613gzcswh}]; tasks: [Task[sensor z613gzcswh:service.state.expected]@kx0ew4c9] Tests run: 2717, Failures: 1, Errors: 0, Skipped: 0 [INFO] ------------------------------------------------------------------------ [INFO] Reactor Summary: [INFO] [INFO] Brooklyn Server Root ............................... SUCCESS [ 2.280 s] [INFO] Brooklyn Parent Project ............................ SUCCESS [ 4.866 s] [INFO] Brooklyn Test Support Utilities .................... SUCCESS [ 7.854 s] [INFO] Brooklyn Logback Includable Configuration .......... SUCCESS [ 0.706 s] [INFO] Brooklyn Common Utilities .......................... SUCCESS [ 37.959 s] [INFO] Brooklyn API ....................................... SUCCESS [ 3.820 s] [INFO] CAMP Server Parent Project ......................... SUCCESS [ 0.461 s] [INFO] CAMP Base .......................................... SUCCESS [ 5.163 s] [INFO] Brooklyn Test Support .............................. SUCCESS [ 5.279 s] [INFO] Brooklyn REST Swagger Apidoc Utilities ............. SUCCESS [ 3.285 s] [INFO] Brooklyn Logback Configuration ..................... SUCCESS [ 0.463 s] [INFO] CAMP Server ........................................ SUCCESS [ 9.586 s] [INFO] Brooklyn Felix Runtime ............................. SUCCESS [ 5.176 s] [INFO] Brooklyn Groovy Utilities .......................... SUCCESS [ 3.682 s] [INFO] Brooklyn Core ...................................... FAILURE [05:41 min] [INFO] Brooklyn Policies .................................. SKIPPED [INFO] Brooklyn WinRM Software Entities ................... SKIPPED [INFO] Brooklyn Secure JMXMP Agent ........................ SKIPPED [INFO] Brooklyn JMX RMI Agent ............................. SKIPPED [INFO] Brooklyn Jclouds Location Targets .................. SKIPPED [INFO] Brooklyn Software Base ............................. SKIPPED [INFO] Brooklyn CAMP ...................................... SKIPPED [INFO] Brooklyn Launcher Common ........................... SKIPPED [INFO] Brooklyn REST API .................................. SKIPPED [INFO] Brooklyn REST Resources ............................ SKIPPED [INFO] Brooklyn REST Server ............................... SKIPPED [INFO] Brooklyn Launcher .................................. SKIPPED [INFO] Brooklyn Container Location Targets ................ SKIPPED [INFO] Brooklyn Command Line Interface .................... SKIPPED [INFO] Brooklyn Test Framework ............................ SKIPPED [INFO] Brooklyn OSGi init ................................. SKIPPED [INFO] Brooklyn OSGi start ................................ SKIPPED [INFO] Brooklyn Karaf ..................................... SKIPPED [INFO] Jetty config fragment .............................. SKIPPED [INFO] Apache Http Component extension .................... SKIPPED [INFO] Brooklyn Karaf Features ............................ SKIPPED [INFO] Brooklyn Karaf Shell Commands ...................... SKIPPED [INFO] ------------------------------------------------------------------------ [INFO] BUILD FAILURE [INFO] ------------------------------------------------------------------------ [INFO] Total time: 07:15 min [INFO] Finished at: 2023-09-15T13:32:37Z [INFO] Final Memory: 91M/1164M [INFO] ------------------------------------------------------------------------ [ERROR] Failed to execute goal org.apache.maven.plugins:maven-surefire-plugin:2.19.1:test (default-test) on project brooklyn-core: There are test failures. [ERROR] [ERROR] Please refer to /home/jenkins/jenkins-agent/712657a4/workspace/Brooklyn_brooklyn-server_master/core/target/surefire-reports for the individual test results. [ERROR] -> [Help 1] [ERROR] [ERROR] To see the full stack trace of the errors, re-run Maven with the -e switch. [ERROR] Re-run Maven using the -X switch to enable full debug logging. [ERROR] [ERROR] For more information about the errors and possible solutions, please read the following articles: [ERROR] [Help 1] http://cwiki.apache.org/confluence/display/MAVEN/MojoFailureException [ERROR] [ERROR] After correcting the problems, you can resume the build with the command [ERROR] mvn <goals> -rf :brooklyn-core [Pipeline] } $ docker stop --time=1 22c3f354bb4c182e1a331dcb3688b89caed71d8aa91cde8b2bd7c83802c2d7c2 $ docker rm -f --volumes 22c3f354bb4c182e1a331dcb3688b89caed71d8aa91cde8b2bd7c83802c2d7c2 [Pipeline] // withDockerContainer [Pipeline] } [Pipeline] // stage [Pipeline] } [Pipeline] // withEnv [Pipeline] } ERROR: script returned exit code 1 [Pipeline] // catchError [Pipeline] stage [Pipeline] { (Publish test results) [Pipeline] junit Recording test results [Checks API] No suitable checks publisher found. [Pipeline] testNG TestNG Reports Processing: START Looking for TestNG results report in workspace using pattern: **/testng-results.xml testng-results.xml was last modified before this build started. Ignoring it. Saving reports... Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results-1.xml' Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results-2.xml' Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results-3.xml' Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results-4.xml' Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results-5.xml' Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results-6.xml' Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results-7.xml' Processing '/home/jenkins/jenkins-home/jobs/Brooklyn/jobs/brooklyn-server/branches/master/builds/514/testng/testng-results.xml' 0.029727% of tests failed, which exceeded threshold of 0%. Marking build as UNSTABLE TestNG Reports Processing: FINISH [Pipeline] } [Pipeline] // stage [Pipeline] stage [Pipeline] { (Send notifications) [Pipeline] step