mesos-builds mailing list archives

Site index · List index
Message view « Date » · « Thread »
Top « Date » · « Thread »
From Apache Jenkins Server <jenk...@builds.apache.org>
Subject Build failed in Jenkins: Mesos-Reviewbot #18641
Date Sat, 29 Jul 2017 21:04:02 GMT
See <https://builds.apache.org/job/Mesos-Reviewbot/18641/display/redirect>

------------------------------------------
[...truncated 11.56 MB...]
I0729 21:03:54.610826  5124 slave.cpp:1232] Forwarding total oversubscribed resources {}
I0729 21:03:54.610903  5120 hierarchical.cpp:1468] Performed allocation for 1 agents in 307464ns
I0729 21:03:54.611234  5123 master.cpp:6674] Received update of agent 5450835e-044c-4114-80ab-beb476cc3c63-S0
at slave(179)@172.17.0.3:34275 (maintenance-host) with total oversubscribed resources {}
I0729 21:03:54.611881  5119 hierarchical.cpp:660] Agent 5450835e-044c-4114-80ab-beb476cc3c63-S0
(maintenance-host) updated with total resources cpus:2; mem:1024; disk:1024; ports:[31000-32000]
I0729 21:03:54.619972  5098 cluster.cpp:448] Creating default 'local' authorizer
I0729 21:03:54.623527  5123 slave.cpp:250] Mesos agent started on (180)@172.17.0.3:34275
I0729 21:03:54.623558  5123 slave.cpp:251] Flags at startup: --acls="" --appc_simple_discovery_uri_prefix="http://"
--appc_store_dir="/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv/store/appc" --authenticate_http_readonly="true"
--authenticate_http_readwrite="true" --authenticatee="crammd5" --authentication_backoff_factor="1secs"
--authorizer="local" --cgroups_cpu_enable_pids_and_tids_count="false" --cgroups_enable_cfs="false"
--cgroups_hierarchy="/sys/fs/cgroup" --cgroups_limit_swap="false" --cgroups_root="mesos" --container_disk_watch_interval="15secs"
--containerizers="mesos" --credential="/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv/credential"
--default_role="*" --disk_watch_interval="1mins" --docker="docker" --docker_kill_orphans="true"
--docker_registry="https://registry-1.docker.io" --docker_remove_delay="6hrs" --docker_socket="/var/run/docker.sock"
--docker_stop_timeout="0ns" --docker_store_dir="/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv/store/docker"
--docker_volume_checkpoint_dir="/var/run/mesos/isolators/docker/volume" --enforce_container_disk_quota="false"
--executor_registration_timeout="1mins" --executor_reregistration_timeout="2secs" --executor_shutdown_grace_period="5secs"
--fetcher_cache_dir="/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv/fetch" --fetcher_cache_size="2GB"
--frameworks_home="" --gc_delay="1weeks" --gc_disk_headroom="0.1" --hadoop_home="" --help="false"
--hostname="maintenance-host-2" --hostname_lookup="true" --http_command_executor="false" --http_credentials="/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv/http_credentials"
--http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem"
--launcher="posix" --launcher_dir="/mesos/mesos-1.4.0/_build/src" --logbufsecs="0" --logging_level="INFO"
--max_completed_executors_per_framework="150" --oversubscribed_resources_interval="15secs"
--perf_duration="10secs" --perf_interval="1mins" --port="5051" --qos_correction_interval_min="0ns"
--quiet="false" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms"
--resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true"
--runtime_dir="/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv" --sandbox_directory="/mnt/mesos/sandbox"
--strict="true" --switch_user="true" --systemd_enable_support="true" --systemd_runtime_directory="/run/systemd/system"
--version="false" --work_dir="/tmp/MasterMaintenanceTest_InverseOffersFilters_wgEfAw"
I0729 21:03:54.624429  5123 credentials.hpp:86] Loading credential for authentication from
'/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv/credential'
I0729 21:03:54.624861  5123 slave.cpp:283] Agent using credential for: test-principal
I0729 21:03:54.624894  5123 credentials.hpp:37] Loading credentials for authentication from
'/tmp/MasterMaintenanceTest_InverseOffersFilters_0cngtv/http_credentials'
I0729 21:03:54.625380  5123 http.cpp:993] Creating default 'basic' HTTP authenticator for
realm 'mesos-agent-readonly'
I0729 21:03:54.625720  5123 http.cpp:993] Creating default 'basic' HTTP authenticator for
realm 'mesos-agent-readwrite'
I0729 21:03:54.627904  5123 slave.cpp:565] Agent resources: [{"name":"cpus","scalar":{"value":2.0},"type":"SCALAR"},{"name":"mem","scalar":{"value":1024.0},"type":"SCALAR"},{"name":"disk","scalar":{"value":1024.0},"type":"SCALAR"},{"name":"ports","ranges":{"range":[{"begin":31000,"end":32000}]},"type":"RANGES"}]
I0729 21:03:54.628334  5123 slave.cpp:573] Agent attributes: [  ]
I0729 21:03:54.628355  5123 slave.cpp:582] Agent hostname: maintenance-host-2
I0729 21:03:54.628731  5119 status_update_manager.cpp:177] Pausing sending status updates
I0729 21:03:54.630795  5117 state.cpp:64] Recovering state from '/tmp/MasterMaintenanceTest_InverseOffersFilters_wgEfAw/meta'
I0729 21:03:54.631515  5124 status_update_manager.cpp:203] Recovering status update manager
I0729 21:03:54.632074  5123 slave.cpp:6207] Finished recovery
I0729 21:03:54.632944  5123 slave.cpp:6389] Querying resource estimator for oversubscribable
resources
I0729 21:03:54.633497  5119 status_update_manager.cpp:177] Pausing sending status updates
I0729 21:03:54.633512  5123 slave.cpp:971] New master detected at master@172.17.0.3:34275
I0729 21:03:54.633944  5123 slave.cpp:1006] Detecting new master
I0729 21:03:54.634433  5123 slave.cpp:6403] Received oversubscribable resources {} from the
resource estimator
I0729 21:03:54.639494  5124 slave.cpp:1033] Authenticating with master master@172.17.0.3:34275
I0729 21:03:54.639631  5124 slave.cpp:1044] Using default CRAM-MD5 authenticatee
I0729 21:03:54.640046  5120 authenticatee.cpp:121] Creating new client SASL connection
I0729 21:03:54.640578  5122 master.cpp:7823] Authenticating slave(180)@172.17.0.3:34275
I0729 21:03:54.640739  5117 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(393)@172.17.0.3:34275
I0729 21:03:54.641264  5121 authenticator.cpp:98] Creating new server SASL connection
I0729 21:03:54.641726  5119 authenticatee.cpp:213] Received SASL authentication mechanisms:
CRAM-MD5
I0729 21:03:54.641774  5119 authenticatee.cpp:239] Attempting to authenticate with mechanism
'CRAM-MD5'
I0729 21:03:54.641929  5119 authenticator.cpp:204] Received SASL authentication start
I0729 21:03:54.642004  5119 authenticator.cpp:326] Authentication requires more steps
I0729 21:03:54.642138  5119 authenticatee.cpp:259] Received SASL authentication step
I0729 21:03:54.642269  5119 authenticator.cpp:232] Received SASL authentication step
I0729 21:03:54.642310  5119 auxprop.cpp:109] Request to lookup properties for user: 'test-principal'
realm: 'd55809302b62' server FQDN: 'd55809302b62' SASL_AUXPROP_VERIFY_AGAINST_HASH: false
SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false 
I0729 21:03:54.642333  5119 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I0729 21:03:54.642388  5119 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I0729 21:03:54.642422  5119 auxprop.cpp:109] Request to lookup properties for user: 'test-principal'
realm: 'd55809302b62' server FQDN: 'd55809302b62' SASL_AUXPROP_VERIFY_AGAINST_HASH: false
SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true 
I0729 21:03:54.642441  5119 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since
SASL_AUXPROP_AUTHZID == true
I0729 21:03:54.642457  5119 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5'
since SASL_AUXPROP_AUTHZID == true
I0729 21:03:54.642485  5119 authenticator.cpp:318] Authentication success
I0729 21:03:54.642630  5120 authenticatee.cpp:299] Authentication success
I0729 21:03:54.642730  5122 master.cpp:7853] Successfully authenticated principal 'test-principal'
at slave(180)@172.17.0.3:34275
I0729 21:03:54.642779  5119 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(393)@172.17.0.3:34275
I0729 21:03:54.643182  5117 slave.cpp:1128] Successfully authenticated with master master@172.17.0.3:34275
I0729 21:03:54.643615  5117 slave.cpp:1572] Will retry registration in 13.39791ms if necessary
I0729 21:03:54.644049  5120 master.cpp:5707] Received register agent message from slave(180)@172.17.0.3:34275
(maintenance-host-2)
I0729 21:03:54.644304  5120 master.cpp:3803] Authorizing agent with principal 'test-principal'
I0729 21:03:54.645022  5118 master.cpp:5767] Authorized registration of agent at slave(180)@172.17.0.3:34275
(maintenance-host-2)
I0729 21:03:54.645202  5118 master.cpp:5860] Registering agent at slave(180)@172.17.0.3:34275
(maintenance-host-2) with id 5450835e-044c-4114-80ab-beb476cc3c63-S1
I0729 21:03:54.646008  5121 registrar.cpp:493] Applied 1 operations in 173898ns; attempting
to update the registry
I0729 21:03:54.647047  5120 registrar.cpp:550] Successfully updated the registry in 922112ns
I0729 21:03:54.647435  5118 master.cpp:5907] Admitted agent 5450835e-044c-4114-80ab-beb476cc3c63-S1
at slave(180)@172.17.0.3:34275 (maintenance-host-2)
I0729 21:03:54.648370  5121 slave.cpp:4883] Received ping from slave-observer(177)@172.17.0.3:34275
I0729 21:03:54.648753  5121 slave.cpp:1174] Registered with master master@172.17.0.3:34275;
given agent ID 5450835e-044c-4114-80ab-beb476cc3c63-S1
I0729 21:03:54.648994  5120 status_update_manager.cpp:184] Resuming sending status updates
I0729 21:03:54.648442  5118 master.cpp:5938] Registered agent 5450835e-044c-4114-80ab-beb476cc3c63-S1
at slave(180)@172.17.0.3:34275 (maintenance-host-2) with [{"name":"cpus","scalar":{"value":2.0},"type":"SCALAR"},{"name":"mem","scalar":{"value":1024.0},"type":"SCALAR"},{"name":"disk","scalar":{"value":1024.0},"type":"SCALAR"},{"name":"ports","ranges":{"range":[{"begin":31000,"end":32000}]},"type":"RANGES"}]
I0729 21:03:54.649135  5117 hierarchical.cpp:593] Added agent 5450835e-044c-4114-80ab-beb476cc3c63-S1
(maintenance-host-2) with cpus:2; mem:1024; disk:1024; ports:[31000-32000] (allocated: {})
I0729 21:03:54.649533  5121 slave.cpp:1194] Checkpointing SlaveInfo to '/tmp/MasterMaintenanceTest_InverseOffersFilters_wgEfAw/meta/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S1/slave.info'
I0729 21:03:54.649797  5117 hierarchical.cpp:1925] No allocations performed
I0729 21:03:54.649885  5117 hierarchical.cpp:1468] Performed allocation for 1 agents in 326734ns
I0729 21:03:54.650166  5121 slave.cpp:1232] Forwarding total oversubscribed resources {}
I0729 21:03:54.650462  5119 master.cpp:6674] Received update of agent 5450835e-044c-4114-80ab-beb476cc3c63-S1
at slave(180)@172.17.0.3:34275 (maintenance-host-2) with total oversubscribed resources {}
I0729 21:03:54.650977  5119 hierarchical.cpp:660] Agent 5450835e-044c-4114-80ab-beb476cc3c63-S1
(maintenance-host-2) updated with total resources cpus:2; mem:1024; disk:1024; ports:[31000-32000]
I0729 21:03:54.653780  5121 process.cpp:3836] Handling HTTP event for process 'master' with
path: '/master/maintenance/schedule'
I0729 21:03:54.656530  5123 http.cpp:1133] HTTP POST for /master/maintenance/schedule from
172.17.0.3:59774
I0729 21:03:54.658423  5119 registrar.cpp:493] Applied 1 operations in 269980ns; attempting
to update the registry
I0729 21:03:54.659592  5121 registrar.cpp:550] Successfully updated the registry in 1.052928ms
I0729 21:03:54.660143  5118 master.cpp:6749] Updating unavailability of agent 5450835e-044c-4114-80ab-beb476cc3c63-S0
at slave(179)@172.17.0.3:34275 (maintenance-host), starting at 2487.41200213185weeks
I0729 21:03:54.660373  5118 master.cpp:6749] Updating unavailability of agent 5450835e-044c-4114-80ab-beb476cc3c63-S1
at slave(180)@172.17.0.3:34275 (maintenance-host-2), starting at 2487.41200213185weeks
I0729 21:03:54.660914  5119 hierarchical.cpp:1925] No allocations performed
I0729 21:03:54.660998  5119 hierarchical.cpp:1468] Performed allocation for 2 agents in 316918ns
I0729 21:03:54.663902  5098 scheduler.cpp:184] Version: 1.4.0
I0729 21:03:54.664885  5123 scheduler.cpp:470] New master detected at master@172.17.0.3:34275
I0729 21:03:54.664942  5123 scheduler.cpp:479] Waiting for 0ns before initiating a re-(connection)
attempt with the master
I0729 21:03:54.669718  5121 scheduler.cpp:361] Connected with the master at http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.671515  5117 scheduler.cpp:243] Sending SUBSCRIBE call to http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.673949  5124 process.cpp:3836] Handling HTTP event for process 'master' with
path: '/master/api/v1/scheduler'
I0729 21:03:54.676524  5120 http.cpp:1133] HTTP POST for /master/api/v1/scheduler from 172.17.0.3:59778
I0729 21:03:54.676915  5120 master.cpp:2545] Received subscription request for HTTP framework
'default'
I0729 21:03:54.677037  5120 master.cpp:2228] Authorizing framework principal 'test-principal'
to receive offers for roles '{ * }'
I0729 21:03:54.677690  5124 master.cpp:2681] Subscribing framework 'default' with checkpointing
disabled and capabilities [ RESERVATION_REFINEMENT ]
I0729 21:03:54.678661  5124 master.hpp:2215] Sending heartbeat to 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.678721  5119 hierarchical.cpp:303] Added framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.680496  5122 scheduler.cpp:676] Enqueuing event SUBSCRIBED received from http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.681167  5122 scheduler.cpp:676] Enqueuing event HEARTBEAT received from http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.682819  5119 hierarchical.cpp:1468] Performed allocation for 2 agents in 3.685198ms
I0729 21:03:54.683825  5122 master.cpp:7653] Sending 2 offers to framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
(default)
I0729 21:03:54.685134  5121 hierarchical.cpp:1925] No allocations performed
I0729 21:03:54.685305  5122 master.cpp:7742] Sending 2 inverse offers to framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
(default)
I0729 21:03:54.685585  5121 hierarchical.cpp:1468] Performed allocation for 2 agents in 647432ns
I0729 21:03:54.688784  5118 scheduler.cpp:676] Enqueuing event OFFERS received from http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.691349  5119 scheduler.cpp:676] Enqueuing event INVERSE_OFFERS received from
http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.695160  5120 scheduler.cpp:243] Sending ACCEPT call to http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.696415  5120 scheduler.cpp:243] Sending ACCEPT call to http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.698021  5121 process.cpp:3836] Handling HTTP event for process 'master' with
path: '/master/api/v1/scheduler'
I0729 21:03:54.701144  5119 http.cpp:1133] HTTP POST for /master/api/v1/scheduler from 172.17.0.3:59776
I0729 21:03:54.703037  5119 master.cpp:4153] Processing ACCEPT call for offers: [ 5450835e-044c-4114-80ab-beb476cc3c63-O0
] on agent 5450835e-044c-4114-80ab-beb476cc3c63-S0 at slave(179)@172.17.0.3:34275 (maintenance-host)
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 (default)
I0729 21:03:54.703192  5119 master.cpp:3530] Authorizing framework principal 'test-principal'
to launch task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
I0729 21:03:54.704980  5119 process.cpp:3836] Handling HTTP event for process 'master' with
path: '/master/api/v1/scheduler'
W0729 21:03:54.707840  5119 validation.cpp:1294] Executor 'executor-1' for task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
uses less CPUs (None) than the minimum required (0.01). Please update your executor, as this
will be mandatory in future releases.
W0729 21:03:54.707906  5119 validation.cpp:1306] Executor 'executor-1' for task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
uses less memory (None) than the minimum required (32MB). Please update your executor, as
this will be mandatory in future releases.
I0729 21:03:54.709038  5119 master.cpp:9709] Adding task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
with resources [{"allocation_info":{"role":"*"},"name":"cpus","scalar":{"value":2.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"mem","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"disk","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"ports","ranges":{"range":[{"begin":31000,"end":32000}]},"type":"RANGES"}]
on agent 5450835e-044c-4114-80ab-beb476cc3c63-S0 at slave(179)@172.17.0.3:34275 (maintenance-host)
I0729 21:03:54.710467  5119 master.cpp:4816] Launching task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 (default) with resources [{"allocation_info":{"role":"*"},"name":"cpus","scalar":{"value":2.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"mem","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"disk","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"ports","ranges":{"range":[{"begin":31000,"end":32000}]},"type":"RANGES"}]
on agent 5450835e-044c-4114-80ab-beb476cc3c63-S0 at slave(179)@172.17.0.3:34275 (maintenance-host)
I0729 21:03:54.711756  5120 slave.cpp:1697] Got assigned task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.712808  5120 slave.cpp:1978] Authorizing task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.712898  5120 slave.cpp:6706] Authorizing framework principal 'test-principal'
to launch task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
I0729 21:03:54.713611  5117 http.cpp:1133] HTTP POST for /master/api/v1/scheduler from 172.17.0.3:59776
I0729 21:03:54.714382  5121 slave.cpp:2165] Launching task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.714622  5123 hierarchical.cpp:887] Updated allocation of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
on agent 5450835e-044c-4114-80ab-beb476cc3c63-S0 from cpus(allocated: *):2; mem(allocated:
*):1024; disk(allocated: *):1024; ports(allocated: *):[31000-32000] to cpus(allocated: *):2;
mem(allocated: *):1024; disk(allocated: *):1024; ports(allocated: *):[31000-32000]
I0729 21:03:54.715355  5121 paths.cpp:578] Trying to chown '/tmp/MasterMaintenanceTest_InverseOffersFilters_8ZbPbB/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S0/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-1/runs/3c7b02a7-7023-40c9-b63e-f6e7dab98c81'
to user 'mesos'
I0729 21:03:54.715462  5117 master.cpp:4153] Processing ACCEPT call for offers: [ 5450835e-044c-4114-80ab-beb476cc3c63-O1
] on agent 5450835e-044c-4114-80ab-beb476cc3c63-S1 at slave(180)@172.17.0.3:34275 (maintenance-host-2)
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 (default)
I0729 21:03:54.715636  5117 master.cpp:3530] Authorizing framework principal 'test-principal'
to launch task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
I0729 21:03:54.715731  5121 slave.cpp:7162] Launching executor 'executor-1' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
with resources [] in work directory '/tmp/MasterMaintenanceTest_InverseOffersFilters_8ZbPbB/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S0/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-1/runs/3c7b02a7-7023-40c9-b63e-f6e7dab98c81'
I0729 21:03:54.716579  5121 slave.cpp:2852] Launching container 3c7b02a7-7023-40c9-b63e-f6e7dab98c81
for executor 'executor-1' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.717293  5121 slave.cpp:2394] Queued task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
for executor 'executor-1' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.717418  5121 slave.cpp:924] Successfully attached file '/tmp/MasterMaintenanceTest_InverseOffersFilters_8ZbPbB/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S0/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-1/runs/3c7b02a7-7023-40c9-b63e-f6e7dab98c81'
I0729 21:03:54.717499  5121 slave.cpp:924] Successfully attached file '/tmp/MasterMaintenanceTest_InverseOffersFilters_8ZbPbB/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S0/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-1/runs/3c7b02a7-7023-40c9-b63e-f6e7dab98c81'
W0729 21:03:54.719156  5120 validation.cpp:1294] Executor 'executor-2' for task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
uses less CPUs (None) than the minimum required (0.01). Please update your executor, as this
will be mandatory in future releases.
W0729 21:03:54.719213  5120 validation.cpp:1306] Executor 'executor-2' for task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
uses less memory (None) than the minimum required (32MB). Please update your executor, as
this will be mandatory in future releases.
*** Aborted at 1501362234 (unix time) try "date -d @1501362234" if you are using GNU date
***
PC: @     0x2b111cdb182d (unknown)
I0729 21:03:54.720120  5120 master.cpp:9709] Adding task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
with resources [{"allocation_info":{"role":"*"},"name":"cpus","scalar":{"value":2.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"mem","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"disk","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"ports","ranges":{"range":[{"begin":31000,"end":32000}]},"type":"RANGES"}]
on agent 5450835e-044c-4114-80ab-beb476cc3c63-S1 at slave(180)@172.17.0.3:34275 (maintenance-host-2)
I0729 21:03:54.721307  5123 exec.cpp:162] Version: 1.4.0
I0729 21:03:54.721761  5122 exec.cpp:212] Executor started at: executor(65)@172.17.0.3:34275
with pid 5098
I0729 21:03:54.721432  5120 master.cpp:4816] Launching task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 (default) with resources [{"allocation_info":{"role":"*"},"name":"cpus","scalar":{"value":2.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"mem","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"disk","scalar":{"value":1024.0},"type":"SCALAR"},{"allocation_info":{"role":"*"},"name":"ports","ranges":{"range":[{"begin":31000,"end":32000}]},"type":"RANGES"}]
on agent 5450835e-044c-4114-80ab-beb476cc3c63-S1 at slave(180)@172.17.0.3:34275 (maintenance-host-2)
I0729 21:03:54.722065  5122 slave.cpp:3877] Got registration for executor 'executor-1' of
framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 from executor(65)@172.17.0.3:34275
I0729 21:03:54.722666  5118 slave.cpp:1697] Got assigned task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.723706  5118 slave.cpp:1978] Authorizing task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.723808  5118 slave.cpp:6706] Authorizing framework principal 'test-principal'
to launch task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
I0729 21:03:54.725160  5123 exec.cpp:237] Executor registered on agent 5450835e-044c-4114-80ab-beb476cc3c63-S0
I0729 21:03:54.725306  5123 exec.cpp:249] Executor::registered took 90819ns
I0729 21:03:54.725637  5117 slave.cpp:2165] Launching task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
for framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.726017  5121 hierarchical.cpp:887] Updated allocation of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
on agent 5450835e-044c-4114-80ab-beb476cc3c63-S1 from cpus(allocated: *):2; mem(allocated:
*):1024; disk(allocated: *):1024; ports(allocated: *):[31000-32000] to cpus(allocated: *):2;
mem(allocated: *):1024; disk(allocated: *):1024; ports(allocated: *):[31000-32000]
I0729 21:03:54.726269  5122 slave.cpp:2599] Sending queued task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
to executor 'executor-1' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 at executor(65)@172.17.0.3:34275
I0729 21:03:54.726541  5117 paths.cpp:578] Trying to chown '/tmp/MasterMaintenanceTest_InverseOffersFilters_wgEfAw/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S1/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-2/runs/b591c6d8-f367-4066-a085-0048683b97c4'
to user 'mesos'
I0729 21:03:54.726850  5117 slave.cpp:7162] Launching executor 'executor-2' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
with resources [] in work directory '/tmp/MasterMaintenanceTest_InverseOffersFilters_wgEfAw/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S1/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-2/runs/b591c6d8-f367-4066-a085-0048683b97c4'
I0729 21:03:54.727023  5120 exec.cpp:331] Executor asked to run task '22d3bd38-cdde-4ee9-9aa0-5f22273a947b'
I0729 21:03:54.727181  5120 exec.cpp:340] Executor::launchTask took 113596ns
I0729 21:03:54.727437  5120 exec.cpp:571] Executor sending status update TASK_RUNNING (UUID:
b4c55284-6301-42a4-bd81-0b62797dafef) for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b of framework
5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.727720  5117 slave.cpp:2852] Launching container b591c6d8-f367-4066-a085-0048683b97c4
for executor 'executor-2' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.727989  5123 slave.cpp:4341] Handling status update TASK_RUNNING (UUID: b4c55284-6301-42a4-bd81-0b62797dafef)
for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
from executor(65)@172.17.0.3:34275
I0729 21:03:54.728416  5117 slave.cpp:2394] Queued task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
for executor 'executor-2' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.728574  5117 slave.cpp:924] Successfully attached file '/tmp/MasterMaintenanceTest_InverseOffersFilters_wgEfAw/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S1/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-2/runs/b591c6d8-f367-4066-a085-0048683b97c4'
I0729 21:03:54.728627  5117 slave.cpp:924] Successfully attached file '/tmp/MasterMaintenanceTest_InverseOffersFilters_wgEfAw/slaves/5450835e-044c-4114-80ab-beb476cc3c63-S1/frameworks/5450835e-044c-4114-80ab-beb476cc3c63-0000/executors/executor-2/runs/b591c6d8-f367-4066-a085-0048683b97c4'
*** SIGSEGV (@0xf0) received by PID 5098 (TID 0x2b1125415700) from PID 240; stack trace: ***
    @     0x2b114c9da417 (unknown)
    @     0x2b114c9de6f9 (unknown)
    @     0x2b111cb68330 (unknown)
    @     0x2b111cdb182d (unknown)
    @     0x2b111cda76f1 (unknown)
I0729 21:03:54.732386  5121 exec.cpp:162] Version: 1.4.0
    @     0x2b111cdfec9e (unknown)
I0729 21:03:54.733139  5124 exec.cpp:212] Executor started at: executor(66)@172.17.0.3:34275
with pid 5098
I0729 21:03:54.733734  5123 slave.cpp:3877] Got registration for executor 'executor-2' of
framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 from executor(66)@172.17.0.3:34275
I0729 21:03:54.733975  5118 status_update_manager.cpp:323] Received status update TASK_RUNNING
(UUID: b4c55284-6301-42a4-bd81-0b62797dafef) for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.734052  5118 status_update_manager.cpp:500] Creating StatusUpdate stream for
task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.734661  5118 status_update_manager.cpp:377] Forwarding update TASK_RUNNING
(UUID: b4c55284-6301-42a4-bd81-0b62797dafef) for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 to the agent
I0729 21:03:54.735292  5124 exec.cpp:237] Executor registered on agent 5450835e-044c-4114-80ab-beb476cc3c63-S1
I0729 21:03:54.735280  5117 slave.cpp:4793] Forwarding the update TASK_RUNNING (UUID: b4c55284-6301-42a4-bd81-0b62797dafef)
for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
to master@172.17.0.3:34275
I0729 21:03:54.735695  5124 exec.cpp:249] Executor::registered took 244727ns
I0729 21:03:54.735802  5117 slave.cpp:4687] Status update manager successfully handled status
update TASK_RUNNING (UUID: b4c55284-6301-42a4-bd81-0b62797dafef) for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.735877  5117 slave.cpp:4703] Sending acknowledgement for status update TASK_RUNNING
(UUID: b4c55284-6301-42a4-bd81-0b62797dafef) for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 to executor(65)@172.17.0.3:34275
I0729 21:03:54.735925  5123 slave.cpp:2599] Sending queued task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
to executor 'executor-2' of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 at executor(66)@172.17.0.3:34275
I0729 21:03:54.736126  5118 exec.cpp:388] Executor received status update acknowledgement
b4c55284-6301-42a4-bd81-0b62797dafef for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b of framework
5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.736136  5121 master.cpp:6832] Status update TASK_RUNNING (UUID: b4c55284-6301-42a4-bd81-0b62797dafef)
for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
from agent 5450835e-044c-4114-80ab-beb476cc3c63-S0 at slave(179)@172.17.0.3:34275 (maintenance-host)
I0729 21:03:54.736251  5121 master.cpp:6894] Forwarding status update TASK_RUNNING (UUID:
b4c55284-6301-42a4-bd81-0b62797dafef) for task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b of framework
5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.736853  5121 master.cpp:8919] Updating the state of task 22d3bd38-cdde-4ee9-9aa0-5f22273a947b
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 (latest state: TASK_RUNNING, status
update state: TASK_RUNNING)
I0729 21:03:54.736955  5122 exec.cpp:331] Executor asked to run task '1571f0e6-68a7-464c-b8c2-5db3a6facd37'
I0729 21:03:54.737093  5122 exec.cpp:340] Executor::launchTask took 95571ns
I0729 21:03:54.737242  5122 exec.cpp:571] Executor sending status update TASK_RUNNING (UUID:
13fe967a-0636-4735-9d03-fa016495fe5a) for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37 of framework
5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.737661  5117 slave.cpp:4341] Handling status update TASK_RUNNING (UUID: 13fe967a-0636-4735-9d03-fa016495fe5a)
for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37 of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
from executor(66)@172.17.0.3:34275
I0729 21:03:54.738719  5124 status_update_manager.cpp:323] Received status update TASK_RUNNING
(UUID: 13fe967a-0636-4735-9d03-fa016495fe5a) for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.738859  5124 status_update_manager.cpp:500] Creating StatusUpdate stream for
task 1571f0e6-68a7-464c-b8c2-5db3a6facd37 of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
    @     0x556406311a9b os::strerror()
I0729 21:03:54.739328  5117 scheduler.cpp:676] Enqueuing event UPDATE received from http://172.17.0.3:34275/master/api/v1/scheduler
I0729 21:03:54.739738  5124 status_update_manager.cpp:377] Forwarding update TASK_RUNNING
(UUID: 13fe967a-0636-4735-9d03-fa016495fe5a) for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 to the agent
I0729 21:03:54.740289  5121 slave.cpp:4793] Forwarding the update TASK_RUNNING (UUID: 13fe967a-0636-4735-9d03-fa016495fe5a)
for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37 of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
to master@172.17.0.3:34275
I0729 21:03:54.740876  5121 slave.cpp:4687] Status update manager successfully handled status
update TASK_RUNNING (UUID: 13fe967a-0636-4735-9d03-fa016495fe5a) for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.740962  5121 slave.cpp:4703] Sending acknowledgement for status update TASK_RUNNING
(UUID: 13fe967a-0636-4735-9d03-fa016495fe5a) for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 to executor(66)@172.17.0.3:34275
I0729 21:03:54.741134  5117 master.cpp:6832] Status update TASK_RUNNING (UUID: 13fe967a-0636-4735-9d03-fa016495fe5a)
for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37 of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000
from agent 5450835e-044c-4114-80ab-beb476cc3c63-S1 at slave(180)@172.17.0.3:34275 (maintenance-host-2)
I0729 21:03:54.741243  5117 master.cpp:6894] Forwarding status update TASK_RUNNING (UUID:
13fe967a-0636-4735-9d03-fa016495fe5a) for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37 of framework
5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.741549  5121 exec.cpp:388] Executor received status update acknowledgement
13fe967a-0636-4735-9d03-fa016495fe5a for task 1571f0e6-68a7-464c-b8c2-5db3a6facd37 of framework
5450835e-044c-4114-80ab-beb476cc3c63-0000
I0729 21:03:54.741823  5117 master.cpp:8919] Updating the state of task 1571f0e6-68a7-464c-b8c2-5db3a6facd37
of framework 5450835e-044c-4114-80ab-beb476cc3c63-0000 (latest state: TASK_RUNNING, status
update state: TASK_RUNNING)
I0729 21:03:54.744089  5118 scheduler.cpp:676] Enqueuing event UPDATE received from http://172.17.0.3:34275/master/api/v1/scheduler
    @     0x55640632bde5 ErrnoError::ErrnoError()
I0729 21:03:54.749191  5123 scheduler.cpp:243] Sending ACKNOWLEDGE call to http://172.17.0.3:34275/master/api/v1/scheduler
    @     0x55640632bdc1 ErrnoError::ErrnoError()
    @     0x2b111a571a66 _ZZN7process2io8internal4readEiPvmENKUlvE_clEv
    @     0x2b111a5754f1 _ZN7process8internal4LoopIZNS_2io8internal4readEiPvmEUlvE_ZNS3_4readEiS4_mEUlRK6OptionImEE0_S7_mE5startEv
    @     0x2b111a5749c8 _ZN7process4loopIZNS_2io8internal4readEiPvmEUlvE_ZNS2_4readEiS3_mEUlRK6OptionImEE0_S6_NS_11ControlFlowImEEmEENS_6FutureIT3_EERKS5_INS_4UPIDEEOT_OT0_
    @     0x2b111a571d86 process::io::internal::read()
    @     0x2b111a572361 process::io::read()
    @     0x2b111a5cc52e process::network::internal::PollSocketImpl::recv()
    @     0x2b111a67578e process::network::internal::SocketImpl::recv()
    @     0x2b111a5513b3 process::network::internal::Socket<>::recv()
    @     0x2b111a54d6e1 process::http::internal::ConnectionProcess::read()
    @     0x2b111a54e0ad process::http::internal::ConnectionProcess::_read()
    @     0x2b111a55630d _ZZN7process8dispatchINS_4http8internal17ConnectionProcessERKNS_6FutureISsEES5_EEvRKNS_3PIDIT_EEMS9_FvT0_ET1_ENKUlPNS_11ProcessBaseEE_clESI_
    @     0x2b111a55f378 _ZNSt17_Function_handlerIFvPN7process11ProcessBaseEEZNS0_8dispatchINS0_4http8internal17ConnectionProcessERKNS0_6FutureISsEES9_EEvRKNS0_3PIDIT_EEMSD_FvT0_ET1_EUlS2_E_E9_M_invokeERKSt9_Any_dataS2_
    @     0x2b111a60ff9b std::function<>::operator()()
    @     0x2b111a5f360f process::ProcessBase::visit()
    @     0x2b111a5fec72 process::DispatchEvent::visit()
    @     0x556406312d7c process::ProcessBase::serve()
    @     0x2b111a5efb4b process::ProcessManager::resume()
    @     0x2b111a5ebdd8 _ZZN7process14ProcessManager12init_threadsEvENKUlvE_clEv
    @     0x2b111a5fdf52 _ZNSt12_Bind_simpleIFZN7process14ProcessManager12init_threadsEvEUlvE_vEE9_M_invokeIIEEEvSt12_Index_tupleIIXspT_EEE
    @     0x2b111a5fdea9 _ZNSt12_Bind_simpleIFZN7process14ProcessManager12init_threadsEvEUlvE_vEEclEv
    @     0x2b111a5fde42 _ZNSt6thread5_ImplISt12_Bind_simpleIFZN7process14ProcessManager12init_threadsEvEUlvE_vEEE6_M_runEv
    @     0x2b111c3e9a60 (unknown)
    @     0x2b111cb60184 start_thread
make[4]: *** [check-local] Segmentation fault (core dumped)
make[4]: Leaving directory `/mesos/mesos-1.4.0/_build/src'
make[3]: *** [check-am] Error 2
make[3]: Leaving directory `/mesos/mesos-1.4.0/_build/src'
make[2]: *** [check] Error 2
make[2]: Leaving directory `/mesos/mesos-1.4.0/_build/src'
make[1]: *** [check-recursive] Error 1
make[1]: Leaving directory `/mesos/mesos-1.4.0/_build'
make: *** [distcheck] Error 1
+ docker rmi mesos-1501356891-4379
Untagged: mesos-1501356891-4379:latest
Deleted: sha256:445cb9d72dd689b7e520aef749fd5ff0fb8023659cfc6de22cde963d74a97f81
Deleted: sha256:db6026ef95a350ba3d1e998b698590fa68d69f2f3857dfd9a261a86d05516337
Deleted: sha256:7c07fe91c026f7d711ff9cdb6b871bca94627d0864e84fd84b70d07186d6acb5
Deleted: sha256:ebecec0ab6348cc7ee4f6b735f38afa13729d4df2462ce4cc91345dc4ac6e5e3
Deleted: sha256:752925ebee252ca26343eb4a87f34b45b5ee7d9cc5cc609befd5843671fe59a9
Deleted: sha256:0e0c426e9cb487ea6c24870bc24e942a44c72c28bb23bd309dc4caa7bfb8f88b
Deleted: sha256:422b086cdebd84f28060dc7c1bbed2deb708f5671dea641e6f73383091183747
Deleted: sha256:9ecfc5196513eb2fe25b38901772fa42720065d668fc81cbc2c03757639bb5b5
Deleted: sha256:227933c530cafca5bad4ec643fbb5518fd683a55d2377dd469bb4d550543c455
Deleted: sha256:7d6fe3ebe49a73fa41513ec0f985fdb96f6d54fd86938946e6de142c8ae9694b
Deleted: sha256:3b6a418516b46227bf714976fc587a600227e06525a4f2ac1f5da5a3eda1ca17
Deleted: sha256:33c03baaeac00435e203d03dfc5f95df25c2bc919a9e06096b7360831024cff4
Deleted: sha256:ff8799b621fa2ec8707ae9402bb1701b79b9c8c7c966d5d04c06b6d93971067a
Deleted: sha256:605631c29e4bba15d887311c7c667aaa479582c4efe6ba71d97a6472a07c8aff
Deleted: sha256:edfe167ed2e0eb17228b599c945230ba520b1723de024f1b1330c7abbf1af92c
Deleted: sha256:f899d496bcbec4ca95e8b1016679cee8928da81e916a108c4772b44bb2f6830a
Deleted: sha256:1128cdf36d062e4f42e109789983493b807ca90bba04dfa1a099640ec56d491f
Deleted: sha256:e38e13f25d5d9cf40b7c2fd83b10fedbd05413a375738f4dc7840b50cfe87c5c
Deleted: sha256:0555053557de81946eb8d30f9e17737e95be548ccb0cacccc55b63da9374dba8
Deleted: sha256:72f4f4bbee949f05c901fb96845655f4e7aaf93866c3409f49cf16ded123d456
Deleted: sha256:d0493a5dbd0e1b537bc342232605c18818fa2d368485d50a1549245a2bc401d4
Deleted: sha256:33ac2423848bf385d366c8d645fbeef521ac0e26ba116fd0ef2926ee2925d5d5
Deleted: sha256:a5848bb1369a25ffd3993b4264bf3d5a244d9d461073d99bdebe8bb4312d8f53
Deleted: sha256:4b0436a854bc2b82793d86dd88601a0a9ecde76b100c1a3689c4bd5089cbb8bd
Build step 'Execute shell' marked build as failure

Mime
View raw message