You are viewing a plain text version of this content. The canonical link for it is here.
Posted to builds@mesos.apache.org by Apache Jenkins Server <je...@builds.apache.org> on 2017/05/23 23:40:04 UTC
Build failed in Jenkins: Mesos-Buildbot » autotools,clang,--verbose --enable-libevent --enable-ssl,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2) #3714
See <https://builds.apache.org/job/Mesos-Buildbot/BUILDTOOL=autotools,COMPILER=clang,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2)/3714/display/redirect?page=changes>
Changes:
[neil.conway] Added MESOS-7538 to 1.3.0 CHANGELOG.
------------------------------------------
[...truncated 28.41 MB...]
I0523 23:39:57.852903 17283 slave.cpp:957] Detecting new master
I0523 23:39:57.853067 17283 slave.cpp:6170] Received oversubscribable resources {} from the resource estimator
I0523 23:39:57.853153 17285 status_update_manager.cpp:177] Pausing sending status updates
I0523 23:39:57.862995 17286 slave.cpp:984] Authenticating with master master@172.17.0.3:39755
I0523 23:39:57.863143 17286 slave.cpp:995] Using default CRAM-MD5 authenticatee
I0523 23:39:57.863345 17282 authenticatee.cpp:121] Creating new client SASL connection
I0523 23:39:57.863489 17280 scheduler.cpp:361] Connected with the master at https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:57.863639 17291 master.cpp:7477] Authenticating slave(747)@172.17.0.3:39755
I0523 23:39:57.863862 17278 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(1385)@172.17.0.3:39755
I0523 23:39:57.864082 17287 authenticator.cpp:98] Creating new server SASL connection
I0523 23:39:57.864303 17282 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5
I0523 23:39:57.864334 17282 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5'
I0523 23:39:57.864454 17280 authenticator.cpp:204] Received SASL authentication start
I0523 23:39:57.864547 17280 authenticator.cpp:326] Authentication requires more steps
I0523 23:39:57.864682 17283 authenticatee.cpp:259] Received SASL authentication step
I0523 23:39:57.864807 17286 authenticator.cpp:232] Received SASL authentication step
I0523 23:39:57.864843 17286 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '3e4db2c626fb' server FQDN: '3e4db2c626fb' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false
I0523 23:39:57.864868 17286 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I0523 23:39:57.864917 17286 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I0523 23:39:57.864946 17286 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '3e4db2c626fb' server FQDN: '3e4db2c626fb' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true
I0523 23:39:57.864967 17286 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true
I0523 23:39:57.864982 17286 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true
I0523 23:39:57.865001 17286 authenticator.cpp:318] Authentication success
I0523 23:39:57.865139 17281 scheduler.cpp:243] Sending SUBSCRIBE call to https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:57.865478 17292 authenticatee.cpp:299] Authentication success
I0523 23:39:57.865563 17280 master.cpp:7507] Successfully authenticated principal 'test-principal' at slave(747)@172.17.0.3:39755
I0523 23:39:57.865609 17287 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(1385)@172.17.0.3:39755
I0523 23:39:57.865986 17291 slave.cpp:1079] Successfully authenticated with master master@172.17.0.3:39755
I0523 23:39:57.866233 17291 slave.cpp:1507] Will retry registration in 9.633987ms if necessary
I0523 23:39:57.866546 17288 master.cpp:5429] Received register agent message from slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:57.866591 17288 master.cpp:3659] Authorizing agent with principal 'test-principal'
I0523 23:39:57.866945 17288 process.cpp:3730] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I0523 23:39:57.867462 17288 master.cpp:5565] Registering agent at slave(747)@172.17.0.3:39755 (3e4db2c626fb) with id 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0
I0523 23:39:57.867843 17293 registrar.cpp:493] Applied 1 operations in 82888ns; attempting to update the registry
I0523 23:39:57.870596 17293 registrar.cpp:550] Successfully updated the registry in 2.676992ms
I0523 23:39:57.871408 17290 slave.cpp:4749] Received ping from slave-observer(681)@172.17.0.3:39755
I0523 23:39:57.871651 17284 slave.cpp:1125] Registered with master master@172.17.0.3:39755; given agent ID 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0
I0523 23:39:57.871569 17287 master.cpp:5640] Registered agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0523 23:39:57.871769 17284 fetcher.cpp:94] Clearing fetcher cache
I0523 23:39:57.871958 17282 status_update_manager.cpp:184] Resuming sending status updates
I0523 23:39:57.872269 17284 slave.cpp:1153] Checkpointing SlaveInfo to '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_0_w9yGWZ/meta/slaves/1b6e7b88-d2bb-4406-b128-baf52a221f99-S0/slave.info'
I0523 23:39:57.872267 17281 hierarchical.cpp:525] Added agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 (3e4db2c626fb) with cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000] (allocated: {})
I0523 23:39:57.872622 17281 hierarchical.cpp:1850] No allocations performed
I0523 23:39:57.872699 17281 hierarchical.cpp:1434] Performed allocation for 1 agents in 283487ns
I0523 23:39:57.872779 17284 slave.cpp:1191] Forwarding total oversubscribed resources {}
I0523 23:39:57.872951 17288 master.cpp:6326] Received update of agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb) with total oversubscribed resources {}
I0523 23:39:57.903640 17286 http.cpp:1115] HTTP POST for /master/api/v1/scheduler from 172.17.0.3:50678
I0523 23:39:57.905176 17286 master.cpp:2513] Received subscription request for HTTP framework 'default'
I0523 23:39:57.905210 17286 master.cpp:2197] Authorizing framework principal 'test-principal' to receive offers for roles '{ * }'
I0523 23:39:57.905649 17293 master.cpp:2628] Subscribing framework 'default' with checkpointing disabled and capabilities [ ]
I0523 23:39:57.906229 17283 master.hpp:2194] Sending heartbeat to 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:57.906308 17287 hierarchical.cpp:273] Added framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:57.907377 17287 hierarchical.cpp:1940] No inverse offers to send out!
I0523 23:39:57.907429 17287 hierarchical.cpp:1434] Performed allocation for 1 agents in 1.022739ms
I0523 23:39:57.908025 17285 master.cpp:7307] Sending 1 offers to framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (default)
I0523 23:39:57.943256 17278 scheduler.cpp:676] Enqueuing event SUBSCRIBED received from https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:57.944141 17281 scheduler.cpp:676] Enqueuing event HEARTBEAT received from https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:57.945361 17292 scheduler.cpp:676] Enqueuing event OFFERS received from https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:57.947924 17279 scheduler.cpp:243] Sending ACCEPT call to https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:57.948971 17281 process.cpp:3730] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I0523 23:39:57.987547 17286 http.cpp:1115] HTTP POST for /master/api/v1/scheduler from 172.17.0.3:50679
I0523 23:39:57.988454 17286 master.cpp:3875] Processing ACCEPT call for offers: [ 1b6e7b88-d2bb-4406-b128-baf52a221f99-O0 ] on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb) for framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (default)
I0523 23:39:57.988550 17286 master.cpp:3426] Authorizing framework principal 'test-principal' to launch task a15e1d70-102b-4902-a293-699a4cf1140b
W0523 23:39:57.990703 17286 validation.cpp:1284] Executor 'default' for task 'a15e1d70-102b-4902-a293-699a4cf1140b' uses less CPUs (None) than the minimum required (0.01). Please update your executor, as this will be mandatory in future releases.
W0523 23:39:57.990734 17286 validation.cpp:1296] Executor 'default' for task 'a15e1d70-102b-4902-a293-699a4cf1140b' uses less memory (None) than the minimum required (32MB). Please update your executor, as this will be mandatory in future releases.
I0523 23:39:57.991237 17286 master.cpp:9328] Adding task a15e1d70-102b-4902-a293-699a4cf1140b with resources cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:57.991575 17286 master.cpp:4531] Launching task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (default) with resources cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:57.992023 17278 slave.cpp:1617] Got assigned task 'a15e1d70-102b-4902-a293-699a4cf1140b' for framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:57.992655 17278 slave.cpp:1898] Authorizing task 'a15e1d70-102b-4902-a293-699a4cf1140b' for framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:57.992718 17278 slave.cpp:6593] Authorizing framework principal 'test-principal' to launch task a15e1d70-102b-4902-a293-699a4cf1140b
I0523 23:39:57.993669 17283 slave.cpp:2085] Launching task 'a15e1d70-102b-4902-a293-699a4cf1140b' for framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:57.994030 17284 hierarchical.cpp:850] Updated allocation of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-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]
I0523 23:39:57.995652 17283 paths.cpp:573] Trying to chown '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_0_w9yGWZ/slaves/1b6e7b88-d2bb-4406-b128-baf52a221f99-S0/frameworks/1b6e7b88-d2bb-4406-b128-baf52a221f99-0000/executors/default/runs/86be043d-c2d4-4601-b13f-a28763a8667e' to user 'mesos'
I0523 23:39:57.995877 17283 slave.cpp:6933] Launching executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 with resources {} in work directory '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_0_w9yGWZ/slaves/1b6e7b88-d2bb-4406-b128-baf52a221f99-S0/frameworks/1b6e7b88-d2bb-4406-b128-baf52a221f99-0000/executors/default/runs/86be043d-c2d4-4601-b13f-a28763a8667e'
I0523 23:39:57.996573 17283 slave.cpp:2314] Queued task 'a15e1d70-102b-4902-a293-699a4cf1140b' for executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:57.996642 17283 slave.cpp:875] Successfully attached file '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_0_w9yGWZ/slaves/1b6e7b88-d2bb-4406-b128-baf52a221f99-S0/frameworks/1b6e7b88-d2bb-4406-b128-baf52a221f99-0000/executors/default/runs/86be043d-c2d4-4601-b13f-a28763a8667e'
I0523 23:39:57.998862 17285 executor.cpp:192] Version: 1.4.0
I0523 23:39:58.014292 17278 executor.cpp:410] Connected with the agent
I0523 23:39:58.014802 17282 executor.cpp:307] Sending SUBSCRIBE call to https://172.17.0.3:39755/slave(747)/api/v1/executor
I0523 23:39:58.015935 17285 process.cpp:3730] Handling HTTP event for process 'slave(747)' with path: '/slave(747)/api/v1/executor'
I0523 23:39:58.056494 17291 http.cpp:1115] HTTP POST for /slave(747)/api/v1/executor from 172.17.0.3:50680
I0523 23:39:58.056676 17291 slave.cpp:3572] Received Subscribe request for HTTP executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.057943 17291 slave.cpp:2527] Sending queued task 'a15e1d70-102b-4902-a293-699a4cf1140b' to executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (via HTTP)
I0523 23:39:58.095566 17283 executor.cpp:725] Enqueuing event SUBSCRIBED received from https://172.17.0.3:39755/slave(747)/api/v1/executor
I0523 23:39:58.096316 17285 executor.cpp:725] Enqueuing event LAUNCH received from https://172.17.0.3:39755/slave(747)/api/v1/executor
I0523 23:39:58.097128 17287 executor.cpp:307] Sending UPDATE call to https://172.17.0.3:39755/slave(747)/api/v1/executor
I0523 23:39:58.097997 17284 process.cpp:3730] Handling HTTP event for process 'slave(747)' with path: '/slave(747)/api/v1/executor'
I0523 23:39:58.136401 17280 http.cpp:1115] HTTP POST for /slave(747)/api/v1/executor from 172.17.0.3:50681
I0523 23:39:58.136584 17280 slave.cpp:4219] Handling status update TASK_RUNNING (UUID: 469a85a1-b04a-492b-8f26-748188ac8820) for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.137302 17291 status_update_manager.cpp:323] Received status update TASK_RUNNING (UUID: 469a85a1-b04a-492b-8f26-748188ac8820) for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.137352 17291 status_update_manager.cpp:500] Creating StatusUpdate stream for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.137866 17291 status_update_manager.cpp:377] Forwarding update TASK_RUNNING (UUID: 469a85a1-b04a-492b-8f26-748188ac8820) for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 to the agent
I0523 23:39:58.138119 17285 slave.cpp:4659] Forwarding the update TASK_RUNNING (UUID: 469a85a1-b04a-492b-8f26-748188ac8820) for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 to master@172.17.0.3:39755
I0523 23:39:58.138324 17285 slave.cpp:4553] Status update manager successfully handled status update TASK_RUNNING (UUID: 469a85a1-b04a-492b-8f26-748188ac8820) for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.138501 17292 master.cpp:6471] Status update TASK_RUNNING (UUID: 469a85a1-b04a-492b-8f26-748188ac8820) for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 from agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:58.138564 17292 master.cpp:6539] Forwarding status update TASK_RUNNING (UUID: 469a85a1-b04a-492b-8f26-748188ac8820) for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.138933 17292 master.cpp:8570] Updating the state of task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (latest state: TASK_RUNNING, status update state: TASK_RUNNING)
I0523 23:39:58.139554 17279 executor.cpp:725] Enqueuing event ACKNOWLEDGED received from https://172.17.0.3:39755/slave(747)/api/v1/executor
I0523 23:39:58.140112 17286 scheduler.cpp:676] Enqueuing event UPDATE received from https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:58.142004 17278 scheduler.cpp:243] Sending TEARDOWN call to https://172.17.0.3:39755/master/api/v1/scheduler
I0523 23:39:58.143105 17293 process.cpp:3730] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler'
I0523 23:39:58.183868 17284 http.cpp:1115] HTTP POST for /master/api/v1/scheduler from 172.17.0.3:50679
I0523 23:39:58.184006 17284 master.cpp:8002] Removing framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (default)
I0523 23:39:58.184037 17284 master.cpp:3160] Deactivating framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (default)
I0523 23:39:58.184202 17288 hierarchical.cpp:374] Deactivated framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.184260 17284 master.cpp:8570] Updating the state of task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (latest state: TASK_KILLED, status update state: TASK_KILLED)
I0523 23:39:58.184270 17287 slave.cpp:3061] Asked to shut down framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 by master@172.17.0.3:39755
I0523 23:39:58.184422 17287 slave.cpp:3086] Shutting down framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.184533 17287 slave.cpp:5486] Shutting down executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (via HTTP)
I0523 23:39:58.185446 17287 executor.cpp:725] Enqueuing event SHUTDOWN received from https://172.17.0.3:39755/slave(747)/api/v1/executor
I0523 23:39:58.185397 17284 master.cpp:8664] Removing task a15e1d70-102b-4902-a293-699a4cf1140b with resources cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:58.185820 17284 master.cpp:8693] Removing executor 'default' with resources {} of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:58.185853 17281 hierarchical.cpp:1114] Recovered cpus(*)(allocated: *):2; mem(*)(allocated: *):1024; disk(*)(allocated: *):1024; ports(*)(allocated: *):[31000-32000] (total: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000], allocated: {}) on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 from framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.186627 17285 hierarchical.cpp:325] Removed framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
E0523 23:39:58.186895 17288 scheduler.cpp:649] End-Of-File received from master. The master closed the event stream
I0523 23:39:58.187443 17284 scheduler.cpp:444] Re-detecting master
I0523 23:39:58.188351 17284 scheduler.cpp:395] Ignoring disconnection attempt from stale connection
I0523 23:39:58.188407 17284 scheduler.cpp:395] Ignoring disconnection attempt from stale connection
I0523 23:39:58.188508 17284 scheduler.cpp:470] New master detected at master@172.17.0.3:39755
I0523 23:39:58.188544 17284 scheduler.cpp:479] Waiting for 0ns before initiating a re-(connection) attempt with the master
I0523 23:39:58.192421 17290 slave.cpp:5172] Executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 exited with status 0
I0523 23:39:58.192613 17290 slave.cpp:5272] Cleaning up executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (via HTTP)
W0523 23:39:58.192849 17287 master.cpp:6594] Ignoring unknown exited executor 'default' of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 on agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:58.192937 17287 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_0_w9yGWZ/slaves/1b6e7b88-d2bb-4406-b128-baf52a221f99-S0/frameworks/1b6e7b88-d2bb-4406-b128-baf52a221f99-0000/executors/default/runs/86be043d-c2d4-4601-b13f-a28763a8667e' for gc 6.99999776848296days in the future
I0523 23:39:58.193253 17290 slave.cpp:5360] Cleaning up framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.193282 17286 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_0_w9yGWZ/slaves/1b6e7b88-d2bb-4406-b128-baf52a221f99-S0/frameworks/1b6e7b88-d2bb-4406-b128-baf52a221f99-0000/executors/default' for gc 6.9999977654637days in the future
I0523 23:39:58.193401 17283 status_update_manager.cpp:285] Closing status update streams for framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.193547 17283 status_update_manager.cpp:531] Cleaning up status update stream for task a15e1d70-102b-4902-a293-699a4cf1140b of framework 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000
I0523 23:39:58.193605 17288 gc.cpp:55] Scheduling '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_0_w9yGWZ/slaves/1b6e7b88-d2bb-4406-b128-baf52a221f99-S0/frameworks/1b6e7b88-d2bb-4406-b128-baf52a221f99-0000' for gc 6.99999776029037days in the future
I0523 23:39:58.193642 17290 slave.cpp:794] Agent terminating
I0523 23:39:58.193848 17282 master.cpp:1313] Agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb) disconnected
I0523 23:39:58.193879 17282 master.cpp:3197] Disconnecting agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:58.194006 17282 master.cpp:3216] Deactivating agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 at slave(747)@172.17.0.3:39755 (3e4db2c626fb)
I0523 23:39:58.194110 17286 hierarchical.cpp:653] Agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0 deactivated
I0523 23:39:58.196683 17282 master.cpp:1155] Master terminating
I0523 23:39:58.197355 17278 hierarchical.cpp:558] Removed agent 1b6e7b88-d2bb-4406-b128-baf52a221f99-S0
W0523 23:39:58.198567 31636 master.hpp:2677] Failed to close HTTP pipe for 1b6e7b88-d2bb-4406-b128-baf52a221f99-0000 (default)
[ OK ] ContentTypeAndSSLConfig/SchedulerSSLTest.RunTaskAndTeardown/0 (504 ms)
[ RUN ] ContentTypeAndSSLConfig/SchedulerSSLTest.RunTaskAndTeardown/1
E0523 23:39:58.204589 17294 process.cpp:950] Failed to accept socket: future discarded
W0523 23:39:58.208304 17294 process.cpp:3055] Attempted to spawn a process (__http_connection__(1163)@172.17.0.3:39755) after finalizing libprocess!
*** Aborted at 1495582798 (unix time) try "date -d @1495582798" if you are using GNU date ***
I0523 23:39:58.210516 31636 process.cpp:1266] libprocess is initialized on 172.17.0.3:45693 with 16 worker threads
I0523 23:39:58.212257 31636 cluster.cpp:162] Creating default 'local' authorizer
I0523 23:39:58.214478 17309 master.cpp:436] Master e87e743f-d228-41da-86bd-5619376b1618 (3e4db2c626fb) started on 172.17.0.3:45693
I0523 23:39:58.214543 17309 master.cpp:438] Flags at startup: --acls="" --agent_ping_timeout="15secs" --agent_reregister_timeout="10mins" --allocation_interval="1secs" --allocator="HierarchicalDRF" --authenticate_agents="true" --authenticate_frameworks="true" --authenticate_http_frameworks="true" --authenticate_http_readonly="true" --authenticate_http_readwrite="true" --authenticators="crammd5" --authorizers="local" --credentials="/tmp/kaMKPB/credentials" --framework_sorter="drf" --help="false" --hostname_lookup="true" --http_authenticators="basic" --http_framework_authenticators="basic" --initialize_driver_logging="true" --log_auto_initialize="true" --logbufsecs="0" --logging_level="INFO" --max_agent_ping_timeouts="5" --max_completed_frameworks="50" --max_completed_tasks_per_framework="1000" --max_unreachable_tasks_per_framework="1000" --port="5050" --quiet="false" --recovery_agent_removal_limit="100%" --registry="in_memory" --registry_fetch_timeout="1mins" --registry_gc_interval="15mins" --registry_max_agent_age="2weeks" --registry_max_agent_count="102400" --registry_store_timeout="100secs" --registry_strict="false" --root_submissions="true" --user_sorter="drf" --version="false" --webui_dir="/mesos/mesos-1.4.0/_inst/share/mesos/webui" --work_dir="/tmp/kaMKPB/master" --zk_session_timeout="10secs"
I0523 23:39:58.214850 17309 master.cpp:488] Master only allowing authenticated frameworks to register
I0523 23:39:58.214864 17309 master.cpp:502] Master only allowing authenticated agents to register
I0523 23:39:58.214869 17309 master.cpp:515] Master only allowing authenticated HTTP frameworks to register
I0523 23:39:58.214877 17309 credentials.hpp:37] Loading credentials for authentication from '/tmp/kaMKPB/credentials'
I0523 23:39:58.215111 17309 master.cpp:560] Using default 'crammd5' authenticator
I0523 23:39:58.215226 17309 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readonly'
I0523 23:39:58.215373 17309 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readwrite'
I0523 23:39:58.215504 17309 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-master-scheduler'
I0523 23:39:58.215636 17309 master.cpp:640] Authorization enabled
I0523 23:39:58.215770 17301 hierarchical.cpp:158] Initialized hierarchical allocator process
I0523 23:39:58.215826 17296 whitelist_watcher.cpp:77] No whitelist given
I0523 23:39:58.217797 17308 master.cpp:2161] Elected as the leading master!
I0523 23:39:58.217823 17308 master.cpp:1700] Recovering from registrar
I0523 23:39:58.217936 17307 registrar.cpp:345] Recovering registrar
I0523 23:39:58.219836 17297 registrar.cpp:389] Successfully fetched the registry (0B) in 1.859072ms
I0523 23:39:58.219959 17297 registrar.cpp:493] Applied 1 operations in 36852ns; attempting to update the registry
I0523 23:39:58.222905 17297 registrar.cpp:550] Successfully updated the registry in 2.887168ms
I0523 23:39:58.223019 17297 registrar.cpp:422] Successfully recovered registrar
I0523 23:39:58.223527 17308 master.cpp:1799] Recovered 0 agents from the registry (129B); allowing 10mins for agents to re-register
I0523 23:39:58.223549 17299 hierarchical.cpp:185] Skipping recovery of hierarchical allocator: nothing to recover
PC: @ 0x2ae28a891918 process::PID<>::PID()
*** SIGSEGV (@0x0) received by PID 31636 (TID 0x2ae298195700) from PID 0; stack trace: ***
@ 0x2ae29b180417 (unknown)
I0523 23:39:58.228039 31636 cluster.cpp:448] Creating default 'local' authorizer
@ 0x2ae29b1846f9 (unknown)
@ 0x2ae28d262330 (unknown)
I0523 23:39:58.229476 17309 slave.cpp:225] Mesos agent started on (748)@172.17.0.3:45693
I0523 23:39:58.229509 17309 slave.cpp:226] Flags at startup: --acls="" --appc_simple_discovery_uri_prefix="http://" --appc_store_dir="/tmp/mesos/store/appc" --authenticate_http_executors="true" --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/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_I0JvgW/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/mesos/store/docker" --docker_volume_checkpoint_dir="/var/run/mesos/isolators/docker/volume" --enforce_container_disk_quota="false" --executor_registration_timeout="1mins" --executor_secret_key="/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_I0JvgW/executor_secret_key" --executor_shutdown_grace_period="5secs" --fetcher_cache_dir="/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_I0JvgW/fetch" --fetcher_cache_size="2GB" --frameworks_home="" --gc_delay="1weeks" --gc_disk_headroom="0.1" --hadoop_home="" --help="false" --hostname_lookup="true" --http_command_executor="false" --http_credentials="/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_I0JvgW/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/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_I0JvgW" --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/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_8ZB72g"
I0523 23:39:58.229959 31636 scheduler.cpp:184] Version: 1.4.0
I0523 23:39:58.229972 17309 credentials.hpp:86] Loading credential for authentication from '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_I0JvgW/credential'
I0523 23:39:58.230139 17309 slave.cpp:258] Agent using credential for: test-principal
I0523 23:39:58.230164 17309 credentials.hpp:37] Loading credentials for authentication from '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_I0JvgW/http_credentials'
I0523 23:39:58.230510 17309 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-executor'
I0523 23:39:58.230579 17302 scheduler.cpp:470] New master detected at master@172.17.0.3:45693
I0523 23:39:58.230633 17309 http.cpp:996] Creating default 'jwt' HTTP authenticator for realm 'mesos-agent-executor'
I0523 23:39:58.230847 17309 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I0523 23:39:58.230942 17309 http.cpp:996] Creating default 'jwt' HTTP authenticator for realm 'mesos-agent-readonly'
I0523 23:39:58.231158 17309 http.cpp:975] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-readwrite'
I0523 23:39:58.231256 17309 http.cpp:996] Creating default 'jwt' HTTP authenticator for realm 'mesos-agent-readwrite'
I0523 23:39:58.232244 17302 scheduler.cpp:479] Waiting for 0ns before initiating a re-(connection) attempt with the master
I0523 23:39:58.233103 17309 slave.cpp:529] Agent resources: cpus(*):2; mem(*):1024; disk(*):1024; ports(*):[31000-32000]
I0523 23:39:58.233206 17309 slave.cpp:537] Agent attributes: [ ]
I0523 23:39:58.233225 17309 slave.cpp:542] Agent hostname: 3e4db2c626fb
I0523 23:39:58.233348 17297 status_update_manager.cpp:177] Pausing sending status updates
I0523 23:39:58.234813 17297 state.cpp:62] Recovering state from '/tmp/ContentTypeAndSSLConfig_SchedulerSSLTest_RunTaskAndTeardown_1_8ZB72g/meta'
I0523 23:39:58.235049 17301 status_update_manager.cpp:203] Recovering status update manager
I0523 23:39:58.235415 17295 slave.cpp:5974] Finished recovery
I0523 23:39:58.235810 17295 slave.cpp:6156] Querying resource estimator for oversubscribable resources
I0523 23:39:58.236032 17299 slave.cpp:6170] Received oversubscribable resources {} from the resource estimator
I0523 23:39:58.236174 17299 slave.cpp:922] New master detected at master@172.17.0.3:45693
I0523 23:39:58.236232 17299 slave.cpp:957] Detecting new master
I0523 23:39:58.236250 17306 status_update_manager.cpp:177] Pausing sending status updates
@ 0x2ae28a891918 process::PID<>::PID()
@ 0x2ae28a86eb9c process::Process<>::self()
@ 0x2ae28a8542ea process::ProcessManager::spawn()
@ 0x2ae28a85ab26 process::spawn()
@ 0x2ae28a78fc95 process::spawn<>()
@ 0x2ae28a78fbdb process::http::Connection::Data::Data()
@ 0x2ae28a78fb76 _ZN9__gnu_cxx13new_allocatorIN7process4http10Connection4DataEE9constructIS4_JRKNS1_7network8internal6SocketINS7_7AddressEEEEEEvPT_DpOT0_
@ 0x2ae28a78fb1d _ZNSt16allocator_traitsISaIN7process4http10Connection4DataEEE12_S_constructIS3_JRKNS0_7network8internal6SocketINS7_7AddressEEEEEENSt9enable_ifIXsr18__construct_helperIT_DpT0_EE5valueEvE4typeERS4_PSF_DpOSG_
@ 0x2ae28a78f770 _ZNSt16allocator_traitsISaIN7process4http10Connection4DataEEE9constructIS3_JRKNS0_7network8internal6SocketINS7_7AddressEEEEEEDTcl12_S_constructfp_fp0_spclsr3stdE7forwardIT0_Efp1_EEERS4_PT_DpOSE_
@ 0x2ae28a78f69a _ZNSt23_Sp_counted_ptr_inplaceIN7process4http10Connection4DataESaIS3_ELN9__gnu_cxx12_Lock_policyE2EEC2IJRKNS0_7network8internal6SocketINS9_7AddressEEEEEES4_DpOT_
@ 0x2ae28a78f54b _ZN9__gnu_cxx13new_allocatorISt23_Sp_counted_ptr_inplaceIN7process4http10Connection4DataESaIS5_ELNS_12_Lock_policyE2EEE9constructIS8_JKS6_RKNS2_7network8internal6SocketINSC_7AddressEEEEEEvPT_DpOT0_
@ 0x2ae28a78f4b2 _ZNSt16allocator_traitsISaISt23_Sp_counted_ptr_inplaceIN7process4http10Connection4DataESaIS4_ELN9__gnu_cxx12_Lock_policyE2EEEE12_S_constructIS8_JKS5_RKNS1_7network8internal6SocketINSD_7AddressEEEEEENSt9enable_ifIXsr18__construct_helperIT_DpT0_EE5valueEvE4typeERS9_PSL_DpOSM_
@ 0x2ae28a78f3a5 _ZNSt16allocator_traitsISaISt23_Sp_counted_ptr_inplaceIN7process4http10Connection4DataESaIS4_ELN9__gnu_cxx12_Lock_policyE2EEEE9constructIS8_JKS5_RKNS1_7network8internal6SocketINSD_7AddressEEEEEEDTcl12_S_constructfp_fp0_spclsr3stdE7forwardIT0_Efp1_EEERS9_PT_DpOSK_
@ 0x2ae28a78f218 _ZNSt14__shared_countILN9__gnu_cxx12_Lock_policyE2EEC2IN7process4http10Connection4DataESaIS7_EJRKNS4_7network8internal6SocketINS9_7AddressEEEEEESt19_Sp_make_shared_tagPT_RKT0_DpOT1_
@ 0x2ae28a78f12f _ZNSt12__shared_ptrIN7process4http10Connection4DataELN9__gnu_cxx12_Lock_policyE2EEC2ISaIS3_EJRKNS0_7network8internal6SocketINS9_7AddressEEEEEESt19_Sp_make_shared_tagRKT_DpOT0_
@ 0x2ae28a78f0bd _ZNSt10shared_ptrIN7process4http10Connection4DataEEC2ISaIS3_EJRKNS0_7network8internal6SocketINS7_7AddressEEEEEESt19_Sp_make_shared_tagRKT_DpOT0_
@ 0x2ae28a78efff _ZSt15allocate_sharedIN7process4http10Connection4DataESaIS3_EJRKNS0_7network8internal6SocketINS5_7AddressEEEEESt10shared_ptrIT_ERKT0_DpOT1_
@ 0x2ae28a76950d _ZSt11make_sharedIN7process4http10Connection4DataEJRKNS0_7network8internal6SocketINS4_7AddressEEEEESt10shared_ptrIT_EDpOT0_
@ 0x2ae28a7226dd process::http::Connection::Connection()
@ 0x2ae28a75750f process::http::connect()::$_1::operator()()
@ 0x2ae28a75728f std::_Function_handler<>::_M_invoke()
@ 0x2ae289a4c3bd std::function<>::operator()()
@ 0x2ae289a4c360 _ZNSt5_BindIFSt8functionIFN7process6FutureINS1_4http10ConnectionEEEvEEvEE6__callIS5_JRK7NothingEJEEET_OSt5tupleIJDpT0_EESt12_Index_tupleIJXspT1_EEE
@ 0x2ae289a4c315 _ZNSt5_BindIFSt8functionIFN7process6FutureINS1_4http10ConnectionEEEvEEvEEclIJRK7NothingES5_EET0_DpOT_
@ 0x2ae289a4bfb4 std::_Function_handler<>::_M_invoke()
@ 0x2ae289a4e02a std::function<>::operator()()
@ 0x2ae289a4cbf1 process::internal::thenf<>()
@ 0x2ae289a4d8c3 _ZNSt5_BindIFPFvRKSt8functionIFN7process6FutureINS1_4http10ConnectionEEERK7NothingEERKSt10shared_ptrINS1_7PromiseIS4_EEERKNS2_IS6_EEESA_SG_St12_PlaceholderILi1EEEE6__callIvJSL_EJLm0ELm1ELm2EEEET_OSt5tupleIJDpT0_EESt12_Index_tupleIJXspT1_EEE
@ 0x2ae289a4d806 _ZNSt5_BindIFPFvRKSt8functionIFN7process6FutureINS1_4http10ConnectionEEERK7NothingEERKSt10shared_ptrINS1_7PromiseIS4_EEERKNS2_IS6_EEESA_SG_St12_PlaceholderILi1EEEEclIJSL_EvEET0_DpOT_
make[4]: *** [check-local] Segmentation fault
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-1495579475-10057
Untagged: mesos-1495579475-10057:latest
Deleted: sha256:664e8fd8e55de426db034e4b3fabbf09b523dd2bbf96111f89637d1dc1b384b0
Deleted: sha256:f2553ca24992e6d1923a7f53455801f9d6ef276424416d46357b5551a5f2cbb6
Deleted: sha256:d0120db4ac4523d40cb61ab29a9bc092fabf292570e01231084b210a2c65c5e2
Deleted: sha256:6862f388a8d4628ec9a40219f3cc2533547e1522f303ad9880394d08e636fe77
Deleted: sha256:763ef65b8faa721a9f50c81eee3855cb3f15a4029a6751e0c03111f66d46ddd0
Deleted: sha256:7aac23115f2f1e19cd450b231872ead7523fea5e2be9294016bef4c9a0f207ba
Deleted: sha256:7129c3fde7fc9590025e837ff4b328c46052616736bb5a77a515537f1b6341ee
Deleted: sha256:c628321c3a9f12211a4366e36edc87f460b86c90f99cc1d5ff7f513a8406e334
Deleted: sha256:c4e7855c82de7e2ee73fe28eb96df55f625d8ce4d7e60b73fe656ab2a7a2b40f
Build step 'Execute shell' marked build as failure
Not sending mail to unregistered user neil.conway@gmail.com
Jenkins build is back to normal : Mesos-Buildbot » autotools,clang,--verbose --enable-libevent --enable-ssl,GLOG_v=1 MESOS_VERBOSE=1,ubuntu:14.04,(docker||Hadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2) #3715
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos-Buildbot/BUILDTOOL=autotools,COMPILER=clang,CONFIGURATION=--verbose%20--enable-libevent%20--enable-ssl,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(docker%7C%7CHadoop)&&(!ubuntu-us1)&&(!ubuntu-eu2)/3715/display/redirect?page=changes>