See <https://builds.apache.org/job/Mesos-Buildbot/BUILDTOOL=cmake,COMPILER=clang,CONFIGURATION=--verbose%20--disable-libtool-wrappers,ENVIRONMENT=GLOG_v=1%20MESOS_VERBOSE=1,OS=ubuntu%3A14.04,label_exp=(ubuntu)&&(!ubuntu-us1)&&(!ubuntu-eu2)&&(!qnode3)&&(!H23)/4458/display/redirect?page=changes>
Changes: [alexr] Revert "Handled the resource conversion for new operations in master." [yujie.jay] Handled the resource conversion for new operations in master. [Kapil Arya] Updated RC tagging+voting mechanism. ------------------------------------------ [...truncated 5.06 MB...] 3: I1114 22:23:54.153551 15913 state.cpp:64] Recovering state from '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/meta' 3: I1114 22:23:54.153776 15908 status_update_manager.cpp:203] Recovering status update manager 3: I1114 22:23:54.154068 15904 slave.cpp:6432] Finished recovery 3: I1114 22:23:54.154662 15909 status_update_manager.cpp:177] Pausing sending status updates 3: I1114 22:23:54.154690 15903 slave.cpp:1007] New master detected at [email protected]:44272 3: I1114 22:23:54.154803 15903 slave.cpp:1042] Detecting new master 3: I1114 22:23:54.160048 15916 slave.cpp:1069] Authenticating with master [email protected]:44272 3: I1114 22:23:54.160112 15916 slave.cpp:1078] Using default CRAM-MD5 authenticatee 3: I1114 22:23:54.160331 15915 authenticatee.cpp:121] Creating new client SASL connection 3: I1114 22:23:54.160604 15905 master.cpp:8285] Authenticating slave(96)@172.17.0.2:44272 3: I1114 22:23:54.160701 15902 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(202)@172.17.0.2:44272 3: I1114 22:23:54.160903 15913 authenticator.cpp:98] Creating new server SASL connection 3: I1114 22:23:54.161093 15912 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5 3: I1114 22:23:54.161116 15912 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5' 3: I1114 22:23:54.161213 15911 authenticator.cpp:204] Received SASL authentication start 3: I1114 22:23:54.161264 15911 authenticator.cpp:326] Authentication requires more steps 3: I1114 22:23:54.161358 15908 authenticatee.cpp:259] Received SASL authentication step 3: I1114 22:23:54.161485 15906 authenticator.cpp:232] Received SASL authentication step 3: I1114 22:23:54.161520 15906 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '36cb246a5077' server FQDN: '36cb246a5077' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false 3: I1114 22:23:54.161537 15906 auxprop.cpp:181] Looking up auxiliary property '*userPassword' 3: I1114 22:23:54.161581 15906 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5' 3: I1114 22:23:54.161613 15906 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '36cb246a5077' server FQDN: '36cb246a5077' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true 3: I1114 22:23:54.161674 15906 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true 3: I1114 22:23:54.161689 15906 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true 3: I1114 22:23:54.161707 15906 authenticator.cpp:318] Authentication success 3: I1114 22:23:54.161789 15910 authenticatee.cpp:299] Authentication success 3: I1114 22:23:54.161855 15904 master.cpp:8315] Successfully authenticated principal 'test-principal' at slave(96)@172.17.0.2:44272 3: I1114 22:23:54.161911 15907 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(202)@172.17.0.2:44272 3: I1114 22:23:54.162109 15914 slave.cpp:1161] Successfully authenticated with master [email protected]:44272 3: I1114 22:23:54.162345 15914 slave.cpp:1682] Will retry registration in 8.042063ms if necessary 3: I1114 22:23:54.162554 15915 master.cpp:6032] Received register agent message from slave(96)@172.17.0.2:44272 (maintenance-host-2) 3: I1114 22:23:54.162588 15915 master.cpp:3870] Authorizing agent with principal 'test-principal' 3: I1114 22:23:54.162969 15902 master.cpp:6092] Authorized registration of agent at slave(96)@172.17.0.2:44272 (maintenance-host-2) 3: I1114 22:23:54.163059 15902 master.cpp:6185] Registering agent at slave(96)@172.17.0.2:44272 (maintenance-host-2) with id e40100c5-1704-4041-8d24-fca0b3944974-S1 3: I1114 22:23:54.163383 15913 registrar.cpp:495] Applied 1 operations in 82281ns; attempting to update the registry 3: I1114 22:23:54.163928 15913 registrar.cpp:552] Successfully updated the registry in 492032ns 3: I1114 22:23:54.164120 15904 master.cpp:6232] Admitted agent e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2) 3: I1114 22:23:54.164837 15906 slave.cpp:1207] Registered with master [email protected]:44272; given agent ID e40100c5-1704-4041-8d24-fca0b3944974-S1 3: I1114 22:23:54.164662 15904 master.cpp:6263] Registered agent e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (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"}] 3: I1114 22:23:54.164955 15905 status_update_manager.cpp:184] Resuming sending status updates 3: I1114 22:23:54.165123 15903 hierarchical.cpp:593] Added agent e40100c5-1704-4041-8d24-fca0b3944974-S1 (maintenance-host-2) with cpus:2; mem:1024; disk:1024; ports:[31000-32000] (allocated: {}) 3: I1114 22:23:54.165226 15906 slave.cpp:1227] Checkpointing SlaveInfo to '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/meta/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/slave.info' 3: I1114 22:23:54.165477 15903 hierarchical.cpp:1450] Performed allocation for 1 agents in 193861ns 3: I1114 22:23:54.165663 15906 slave.cpp:1295] Forwarding total oversubscribed resources {} 3: I1114 22:23:54.165860 15906 master.cpp:7064] Received update of agent e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2) with total oversubscribed resources {} 3: I1114 22:23:54.166061 15906 master.cpp:7082] Ignoring update on agent e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2) as it reports no changes 3: I1114 22:23:54.167349 15909 process.cpp:3925] Handling HTTP event for process 'master' with path: '/master/maintenance/schedule' 3: I1114 22:23:54.168344 15903 http.cpp:1185] HTTP POST for /master/maintenance/schedule from 172.17.0.2:55195 3: I1114 22:23:54.169423 15912 registrar.cpp:495] Applied 1 operations in 152776ns; attempting to update the registry 3: I1114 22:23:54.169915 15912 registrar.cpp:552] Successfully updated the registry in 444928ns 3: I1114 22:23:54.170179 15901 master.cpp:7164] Updating unavailability of agent e40100c5-1704-4041-8d24-fca0b3944974-S0 at slave(95)@172.17.0.2:44272 (maintenance-host), starting at 2502.84814015398weeks 3: I1114 22:23:54.170318 15901 master.cpp:7164] Updating unavailability of agent e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2), starting at 2502.84814015398weeks 3: I1114 22:23:54.170717 15916 hierarchical.cpp:1450] Performed allocation for 2 agents in 218587ns 3: I1114 22:23:54.172092 15900 scheduler.cpp:190] Version: 1.5.0 3: I1114 22:23:54.172338 15908 scheduler.cpp:313] Using default 'basic' HTTP authenticatee 3: I1114 22:23:54.172698 15909 scheduler.cpp:496] New master detected at [email protected]:44272 3: I1114 22:23:54.172719 15909 scheduler.cpp:505] Waiting for 0ns before initiating a re-(connection) attempt with the master 3: I1114 22:23:54.175622 15911 scheduler.cpp:387] Connected with the master at http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.176648 15904 scheduler.cpp:249] Sending SUBSCRIBE call to http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.177968 15906 process.cpp:3925] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler' 3: I1114 22:23:54.179123 15901 http.cpp:1185] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:55196 3: I1114 22:23:54.179316 15901 master.cpp:2613] Received subscription request for HTTP framework 'default' 3: I1114 22:23:54.179355 15901 master.cpp:2278] Authorizing framework principal 'test-principal' to receive offers for roles '{ * }' 3: I1114 22:23:54.179783 15904 master.cpp:2748] Subscribing framework 'default' with checkpointing disabled and capabilities [ RESERVATION_REFINEMENT ] 3: I1114 22:23:54.180605 15902 hierarchical.cpp:303] Added framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.181144 15912 scheduler.cpp:741] Enqueuing event SUBSCRIBED received from http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.181547 15912 scheduler.cpp:741] Enqueuing event HEARTBEAT received from http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.182729 15902 hierarchical.cpp:1450] Performed allocation for 2 agents in 1.963269ms 3: I1114 22:23:54.183387 15910 master.cpp:8115] Sending 2 offers to framework e40100c5-1704-4041-8d24-fca0b3944974-0000 (default) 3: I1114 22:23:54.184268 15910 master.cpp:8204] Sending 2 inverse offers to framework e40100c5-1704-4041-8d24-fca0b3944974-0000 (default) 3: I1114 22:23:54.185873 15909 scheduler.cpp:741] Enqueuing event OFFERS received from http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.186542 15913 scheduler.cpp:741] Enqueuing event INVERSE_OFFERS received from http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.189280 15910 hierarchical.cpp:1450] Performed allocation for 2 agents in 274542ns 3: I1114 22:23:54.190675 15916 scheduler.cpp:249] Sending ACCEPT call to http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.191401 15916 scheduler.cpp:249] Sending ACCEPT call to http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.192895 15913 process.cpp:3925] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler' 3: I1114 22:23:54.194206 15904 process.cpp:3925] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler' 3: I1114 22:23:54.194461 15904 http.cpp:1185] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:55197 3: I1114 22:23:54.195689 15904 master.cpp:10024] Removing offer e40100c5-1704-4041-8d24-fca0b3944974-O0 3: I1114 22:23:54.195879 15904 master.cpp:4228] Processing ACCEPT call for offers: [ e40100c5-1704-4041-8d24-fca0b3944974-O0 ] on agent e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2) for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 (default) 3: I1114 22:23:54.196008 15904 master.cpp:3597] Authorizing framework principal 'test-principal' to launch task 4727b006-97a1-4204-ad30-b637d47c42ac 3: W1114 22:23:54.199185 15904 validation.cpp:1404] Executor 'executor-1' for task '4727b006-97a1-4204-ad30-b637d47c42ac' uses less CPUs (None) than the minimum required (0.01). Please update your executor, as this will be mandatory in future releases. 3: W1114 22:23:54.199223 15904 validation.cpp:1416] Executor 'executor-1' for task '4727b006-97a1-4204-ad30-b637d47c42ac' uses less memory (None) than the minimum required (32MB). Please update your executor, as this will be mandatory in future releases. 3: I1114 22:23:54.199949 15904 master.cpp:10770] Adding task 4727b006-97a1-4204-ad30-b637d47c42ac 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 e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2) 3: I1114 22:23:54.200796 15904 master.cpp:4976] Launching task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-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 e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2) 3: I1114 22:23:54.201550 15911 slave.cpp:1803] Got assigned task '4727b006-97a1-4204-ad30-b637d47c42ac' for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.201603 15912 http.cpp:1185] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:55197 3: I1114 22:23:54.202242 15911 slave.cpp:2071] Authorizing task '4727b006-97a1-4204-ad30-b637d47c42ac' for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.202319 15911 slave.cpp:7253] Authorizing framework principal 'test-principal' to launch task 4727b006-97a1-4204-ad30-b637d47c42ac 3: I1114 22:23:54.202456 15912 master.cpp:10024] Removing offer e40100c5-1704-4041-8d24-fca0b3944974-O1 3: I1114 22:23:54.202600 15912 master.cpp:4228] Processing ACCEPT call for offers: [ e40100c5-1704-4041-8d24-fca0b3944974-O1 ] on agent e40100c5-1704-4041-8d24-fca0b3944974-S0 at slave(95)@172.17.0.2:44272 (maintenance-host) for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 (default) 3: I1114 22:23:54.202688 15912 master.cpp:3597] Authorizing framework principal 'test-principal' to launch task 55cfa224-d8b5-4887-800e-867609b5bfde 3: I1114 22:23:54.203233 15910 slave.cpp:2239] Launching task '4727b006-97a1-4204-ad30-b637d47c42ac' for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.203809 15910 paths.cpp:605] Trying to chown '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/4def2a31-b794-4579-9f9b-23b4c100d0b5' to user 'mesos' 3: I1114 22:23:54.204041 15910 slave.cpp:7727] Launching executor 'executor-1' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 with resources [] in work directory '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/4def2a31-b794-4579-9f9b-23b4c100d0b5' 3: I1114 22:23:54.204682 15910 slave.cpp:2930] Launching container 4def2a31-b794-4579-9f9b-23b4c100d0b5 for executor 'executor-1' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.205044 15910 slave.cpp:2467] Queued task '4727b006-97a1-4204-ad30-b637d47c42ac' for executor 'executor-1' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: W1114 22:23:54.205067 15912 validation.cpp:1404] Executor 'executor-2' for task '55cfa224-d8b5-4887-800e-867609b5bfde' uses less CPUs (None) than the minimum required (0.01). Please update your executor, as this will be mandatory in future releases. 3: W1114 22:23:54.205088 15912 validation.cpp:1416] Executor 'executor-2' for task '55cfa224-d8b5-4887-800e-867609b5bfde' uses less memory (None) than the minimum required (32MB). Please update your executor, as this will be mandatory in future releases. 3: I1114 22:23:54.205142 15910 slave.cpp:958] Successfully attached '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/4def2a31-b794-4579-9f9b-23b4c100d0b5' to virtual path '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/latest' 3: I1114 22:23:54.205189 15910 slave.cpp:958] Successfully attached '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/4def2a31-b794-4579-9f9b-23b4c100d0b5' to virtual path '/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/latest' 3: I1114 22:23:54.205232 15910 slave.cpp:958] Successfully attached '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/4def2a31-b794-4579-9f9b-23b4c100d0b5' to virtual path '/tmp/MasterMaintenanceTest_InverseOffersFilters_IriSpo/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S1/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-1/runs/4def2a31-b794-4579-9f9b-23b4c100d0b5' 3: I1114 22:23:54.205587 15912 master.cpp:10770] Adding task 55cfa224-d8b5-4887-800e-867609b5bfde 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 e40100c5-1704-4041-8d24-fca0b3944974-S0 at slave(95)@172.17.0.2:44272 (maintenance-host) 3: I1114 22:23:54.206161 15912 master.cpp:4976] Launching task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-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 e40100c5-1704-4041-8d24-fca0b3944974-S0 at slave(95)@172.17.0.2:44272 (maintenance-host) 3: I1114 22:23:54.206849 15904 slave.cpp:1803] Got assigned task '55cfa224-d8b5-4887-800e-867609b5bfde' for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: W1114 22:23:54.207324 15903 process.cpp:3178] Attempted to spawn already running process [email protected]:44272 3: I1114 22:23:54.207510 15903 exec.cpp:162] Version: 1.5.0 3: I1114 22:23:54.207661 15904 slave.cpp:2071] Authorizing task '55cfa224-d8b5-4887-800e-867609b5bfde' for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.207738 15904 slave.cpp:7253] Authorizing framework principal 'test-principal' to launch task 55cfa224-d8b5-4887-800e-867609b5bfde 3: I1114 22:23:54.207756 15902 exec.cpp:212] Executor started at: executor(28)@172.17.0.2:44272 with pid 15900 3: I1114 22:23:54.208176 15902 slave.cpp:4063] Got registration for executor 'executor-1' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 from executor(28)@172.17.0.2:44272 3: I1114 22:23:54.208573 15913 slave.cpp:2239] Launching task '55cfa224-d8b5-4887-800e-867609b5bfde' for framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.208614 15914 exec.cpp:237] Executor registered on agent e40100c5-1704-4041-8d24-fca0b3944974-S1 3: I1114 22:23:54.208652 15914 exec.cpp:249] Executor::registered took 26976ns 3: I1114 22:23:54.208928 15902 slave.cpp:2669] Sending queued task '4727b006-97a1-4204-ad30-b637d47c42ac' to executor 'executor-1' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 at executor(28)@172.17.0.2:44272 3: I1114 22:23:54.209245 15910 exec.cpp:331] Executor asked to run task '4727b006-97a1-4204-ad30-b637d47c42ac' 3: I1114 22:23:54.209321 15910 exec.cpp:340] Executor::launchTask took 66512ns 3: I1114 22:23:54.209383 15913 paths.cpp:605] Trying to chown '/tmp/MasterMaintenanceTest_InverseOffersFilters_KxlDuY/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S0/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/ec2d225f-54fb-4ad0-afa4-73b9feb3026b' to user 'mesos' 3: I1114 22:23:54.209410 15910 exec.cpp:571] Executor sending status update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.209619 15913 slave.cpp:7727] Launching executor 'executor-2' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 with resources [] in work directory '/tmp/MasterMaintenanceTest_InverseOffersFilters_KxlDuY/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S0/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/ec2d225f-54fb-4ad0-afa4-73b9feb3026b' 3: I1114 22:23:54.209651 15910 slave.cpp:4517] Handling status update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 from executor(28)@172.17.0.2:44272 3: I1114 22:23:54.210160 15913 slave.cpp:2930] Launching container ec2d225f-54fb-4ad0-afa4-73b9feb3026b for executor 'executor-2' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.210402 15903 status_update_manager.cpp:323] Received status update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.210438 15903 status_update_manager.cpp:500] Creating StatusUpdate stream for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.210835 15903 status_update_manager.cpp:377] Forwarding update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 to the agent 3: I1114 22:23:54.211211 15907 slave.cpp:4998] Forwarding the update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 to [email protected]:44272 3: I1114 22:23:54.211268 15913 slave.cpp:2467] Queued task '55cfa224-d8b5-4887-800e-867609b5bfde' for executor 'executor-2' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.211354 15913 slave.cpp:958] Successfully attached '/tmp/MasterMaintenanceTest_InverseOffersFilters_KxlDuY/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S0/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/ec2d225f-54fb-4ad0-afa4-73b9feb3026b' to virtual path '/tmp/MasterMaintenanceTest_InverseOffersFilters_KxlDuY/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S0/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/latest' 3: I1114 22:23:54.211417 15913 slave.cpp:958] Successfully attached '/tmp/MasterMaintenanceTest_InverseOffersFilters_KxlDuY/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S0/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/ec2d225f-54fb-4ad0-afa4-73b9feb3026b' to virtual path '/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/latest' 3: I1114 22:23:54.211441 15907 slave.cpp:4892] Status update manager successfully handled status update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.211489 15913 slave.cpp:958] Successfully attached '/tmp/MasterMaintenanceTest_InverseOffersFilters_KxlDuY/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S0/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/ec2d225f-54fb-4ad0-afa4-73b9feb3026b' to virtual path '/tmp/MasterMaintenanceTest_InverseOffersFilters_KxlDuY/slaves/e40100c5-1704-4041-8d24-fca0b3944974-S0/frameworks/e40100c5-1704-4041-8d24-fca0b3944974-0000/executors/executor-2/runs/ec2d225f-54fb-4ad0-afa4-73b9feb3026b' 3: I1114 22:23:54.211485 15907 slave.cpp:4908] Sending acknowledgement for status update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 to executor(28)@172.17.0.2:44272 3: I1114 22:23:54.211660 15907 exec.cpp:388] Executor received status update acknowledgement 30db3859-eb53-4760-a0cb-f08e0322ac6f for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.211668 15904 master.cpp:7247] Status update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 from agent e40100c5-1704-4041-8d24-fca0b3944974-S1 at slave(96)@172.17.0.2:44272 (maintenance-host-2) 3: I1114 22:23:54.211774 15904 master.cpp:7309] Forwarding status update TASK_RUNNING (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.212239 15904 master.cpp:9502] Updating the state of task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 (latest state: TASK_RUNNING, status update state: TASK_RUNNING) 3: *** Aborted at 1510698234 (unix time) try "date -d @1510698234" if you are using GNU date *** 3: W1114 22:23:54.213160 15905 process.cpp:3178] Attempted to spawn already running process [email protected]:44272 3: PC: @ 0x2b1348b7e82d (unknown) 3: I1114 22:23:54.213256 15902 scheduler.cpp:741] Enqueuing event UPDATE received from http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.213342 15905 exec.cpp:162] Version: 1.5.0 3: *** SIGSEGV (@0x111) received by PID 15900 (TID 0x2b1350f89700) from PID 273; stack trace: *** 3: I1114 22:23:54.213582 15906 exec.cpp:212] Executor started at: executor(29)@172.17.0.2:44272 with pid 15900 3: @ 0x2b1344cec330 (unknown) 3: I1114 22:23:54.213754 15901 slave.cpp:4063] Got registration for executor 'executor-2' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 from executor(29)@172.17.0.2:44272 3: @ 0x2b1348b7e82d (unknown) 3: I1114 22:23:54.214148 15903 exec.cpp:237] Executor registered on agent e40100c5-1704-4041-8d24-fca0b3944974-S0 3: @ 0x2b1348b746f1 (unknown) 3: I1114 22:23:54.214192 15903 exec.cpp:249] Executor::registered took 30651ns 3: @ 0x2b1348bcbc9e (unknown) 3: I1114 22:23:54.214938 15901 slave.cpp:2669] Sending queued task '55cfa224-d8b5-4887-800e-867609b5bfde' to executor 'executor-2' of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 at executor(29)@172.17.0.2:44272 3: I1114 22:23:54.215339 15904 exec.cpp:331] Executor asked to run task '55cfa224-d8b5-4887-800e-867609b5bfde' 3: I1114 22:23:54.215425 15904 exec.cpp:340] Executor::launchTask took 74478ns 3: I1114 22:23:54.215596 15904 exec.cpp:571] Executor sending status update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.215896 15908 slave.cpp:4517] Handling status update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 from executor(29)@172.17.0.2:44272 3: I1114 22:23:54.216454 15916 status_update_manager.cpp:323] Received status update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.216486 15916 status_update_manager.cpp:500] Creating StatusUpdate stream for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.216900 15916 status_update_manager.cpp:377] Forwarding update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 to the agent 3: I1114 22:23:54.217164 15910 slave.cpp:4998] Forwarding the update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 to [email protected]:44272 3: I1114 22:23:54.217384 15910 slave.cpp:4892] Status update manager successfully handled status update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.217424 15910 slave.cpp:4908] Sending acknowledgement for status update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 to executor(29)@172.17.0.2:44272 3: I1114 22:23:54.217551 15906 master.cpp:7247] Status update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 from agent e40100c5-1704-4041-8d24-fca0b3944974-S0 at slave(95)@172.17.0.2:44272 (maintenance-host) 3: I1114 22:23:54.217607 15906 master.cpp:7309] Forwarding status update TASK_RUNNING (UUID: 09b616e7-289f-43ce-85e6-3748d987a5e2) for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.217631 15905 exec.cpp:388] Executor received status update acknowledgement 09b616e7-289f-43ce-85e6-3748d987a5e2 for task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.218092 15906 master.cpp:9502] Updating the state of task 55cfa224-d8b5-4887-800e-867609b5bfde of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 (latest state: TASK_RUNNING, status update state: TASK_RUNNING) 3: @ 0xa9b305 os::strerror() 3: I1114 22:23:54.223460 15911 scheduler.cpp:249] Sending ACKNOWLEDGE call to http://172.17.0.2:44272/master/api/v1/scheduler 3: I1114 22:23:54.224992 15901 process.cpp:3925] Handling HTTP event for process 'master' with path: '/master/api/v1/scheduler' 3: @ 0xa9b261 ErrnoError::ErrnoError() 3: @ 0xa9b224 ErrnoError::ErrnoError() 3: @ 0x2b1343fa56b7 process::io::internal::read()::$_3::operator()() 3: @ 0x2b1343fa4816 process::internal::Loop<>::start() 3: @ 0x2b1343f822ad process::loop<>() 3: @ 0x2b1343f821c3 process::io::internal::read() 3: @ 0x2b1343f8284c process::io::read() 3: @ 0x2b1344023f7e process::network::internal::PollSocketImpl::recv() 3: @ 0x2b1344175ae9 process::network::internal::SocketImpl::recv() 3: @ 0x2b1343f4179e process::network::internal::Socket<>::recv() 3: @ 0x2b1343f415eb process::http::internal::ConnectionProcess::read() 3: @ 0x2b1343f4284c process::http::internal::ConnectionProcess::_read() 3: @ 0x2b1343f46810 _ZZN7process8dispatchINS_4http8internal17ConnectionProcessERKNS_6FutureISsEES7_EEvRKNS_3PIDIT_EEMS9_FvT0_EOT1_ENKUlRS5_PNS_11ProcessBaseEE_clESI_SK_ 3: @ 0x2b1343f46695 _ZNSt5_BindIFZN7process8dispatchINS0_4http8internal17ConnectionProcessERKNS0_6FutureISsEES8_EEvRKNS0_3PIDIT_EEMSA_FvT0_EOT1_EUlRS6_PNS0_11ProcessBaseEE_S6_St12_PlaceholderILi1EEEE6__callIvJOSL_EJLm0ELm1EEEESA_OSt5tupleIJDpT0_EESt12_Index_tupleIJXspT1_EEE 3: I1114 22:23:54.263962 15905 http.cpp:1185] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:55197 3: I1114 22:23:54.264262 15905 master.cpp:5791] Processing ACKNOWLEDGE call 30db3859-eb53-4760-a0cb-f08e0322ac6f for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 (default) on agent e40100c5-1704-4041-8d24-fca0b3944974-S1 3: @ 0x2b1343f465f6 _ZNSt5_BindIFZN7process8dispatchINS0_4http8internal17ConnectionProcessERKNS0_6FutureISsEES8_EEvRKNS0_3PIDIT_EEMSA_FvT0_EOT1_EUlRS6_PNS0_11ProcessBaseEE_S6_St12_PlaceholderILi1EEEEclIJSL_EvEESE_DpOT_ 3: I1114 22:23:54.264809 15905 status_update_manager.cpp:395] Received status update acknowledgement (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: I1114 22:23:54.265161 15905 slave.cpp:3801] Status update manager successfully handled status update acknowledgement (UUID: 30db3859-eb53-4760-a0cb-f08e0322ac6f) for task 4727b006-97a1-4204-ad30-b637d47c42ac of framework e40100c5-1704-4041-8d24-fca0b3944974-0000 3: @ 0x2b1343f4629f _ZNSt17_Function_handlerIFvPN7process11ProcessBaseEESt5_BindIFZNS0_8dispatchINS0_4http8internal17ConnectionProcessERKNS0_6FutureISsEESC_EEvRKNS0_3PIDIT_EEMSE_FvT0_EOT1_EUlRSA_S2_E_SA_St12_PlaceholderILi1EEEEE9_M_invokeERKSt9_Any_dataS2_ 3: @ 0x2b1344084244 std::function<>::operator()() 3: @ 0x2b1344066ae4 process::ProcessBase::visit() 3: @ 0x2b134411c55e process::DispatchEvent::visit() 3: @ 0xae66a1 process::ProcessBase::serve() 3: @ 0x2b1344064282 process::ProcessManager::resume() 3: @ 0x2b1344074311 process::ProcessManager::init_threads()::$_8::operator()() 3: @ 0x2b1344074255 _ZNSt12_Bind_simpleIFZN7process14ProcessManager12init_threadsEvE3$_8vEE9_M_invokeIJEEEvSt12_Index_tupleIJXspT_EEE 3: @ 0x2b1344074225 std::_Bind_simple<>::operator()() 3: @ 0x2b13440741fc std::thread::_Impl<>::_M_run() 3: @ 0x2b13483d4a60 (unknown) 3: @ 0x2b1344ce4184 start_thread 3/3 Test #3: MesosTests .......................***Exception: SegFault 65.63 sec 67% tests passed, 1 tests failed out of 3 Total Test time (real) = 81.41 sec The following tests FAILED: 3 - MesosTests (SEGFAULT) Errors while running CTest make[3]: *** [CMakeFiles/check] Error 8 make[3]: Leaving directory `/mesos/build' make[2]: *** [CMakeFiles/check.dir/all] Error 2 make[2]: Leaving directory `/mesos/build' make[1]: *** [CMakeFiles/check.dir/rule] Error 2 make[1]: Leaving directory `/mesos/build' make: *** [check] Error 2 + docker rmi mesos-1510696568-22133 Untagged: mesos-1510696568-22133:latest Deleted: sha256:eeb28b7a4ff0948f1cab43a485a166f1dcff587816e480f4c6bb8ee00b99aea2 Deleted: sha256:c635af2a3fd3c7f62fd14bbc3f76fcea991275416e8250b51b7ce1c5558f296e Deleted: sha256:b328baa92c910945a513c27ca56fde5723dda1b89760c076b931288124e3db4a Deleted: sha256:95d71bafc603b15570bb76a540ce1e49257d7859ad63ec07d64cc93742fd69d2 Deleted: sha256:348a6f0021747c9e105773e4c576276e9bc15d6ad114b9a815d5bfe55731d3a7 Deleted: sha256:ea2335df8f4fa13cd1c20942f5b7808a2e80af52c4e6b6b9f5a3023b72cf2e53 Deleted: sha256:54d0f4d92cd79dfcd9f0e45a600c6f728da0d17ec1fdc853bd924007f2defc9c Deleted: sha256:f9f1eb8f2f43172985e1ca91effe589932635a85d1d5d41f9ed36d5590fab1ba Deleted: sha256:85142919615ee80343cf0170ec4cb92bbad447f576cdc48dc57a1d5e202475f1 Deleted: sha256:64431db789f536883c48e78c66f5260512926a634d4281d564c1d4a6f060a532 Deleted: sha256:08af0e50860a13ab944555aa09c1e4c5d3a86702b53b0af3a6a79def7b850d95 Deleted: sha256:b9b12882b5dcd10a0a6154d6c75f40a83b76cb72b11d0696fbc27b526cce8b8d Deleted: sha256:0ab93fe3385b7ccef9c4e158dd632a45c428e8162fbee796883ac2b915818271 Deleted: sha256:262a1daabdec2bd89fe6bd9951621ab65acd27408e365f996cbaf804cb8e3b6b Deleted: sha256:c6a2e7596dbbb5df7932c5325f52e6d3635a95a9c25eb21745e63af2f10fe0cb Deleted: sha256:d5d19f8bb91956c90dbb6566fa15b21f4d258263d720e73ac4437bad0f3b58c6 Deleted: sha256:3f9ceb6637bf4956c161aed1be82cc19009b5548638304870b7e02dc64870a63 Deleted: sha256:fae494876bb496311af31a60ed4208d9e22d5303d88845e8d3202872a6dbf9f9 Deleted: sha256:261a0a9ef6098c48d5e32b50df6f37b30a3e1412196e57e1a50cd28072418f9d Deleted: sha256:952d8f87c05c4c702d91fba17180cb8c2ccd076fa714acff3ee9b692faf14e71 Deleted: sha256:117a013f3252782b5e927e7c8dd05354cbfa0909dc38c27f5140b50dc74943e5 Deleted: sha256:250b4729ae4ba1fc2cba31a7b1c3886d4297e02684ae72cb4566dd3106f31716 Deleted: sha256:acb5974ed6512ab7fdb9ca76a9eab0e7e56e566e047699cb68162c4bd42ba4a4 Deleted: sha256:06a722c44f304d5e712ff40475d78d7f33f74df1faa77e4c8fde03b244a990fb Deleted: sha256:00fa3cb7bd8f34ee0e7fe2c80d90a054953f0957e3625b20a0c9a1e4aee3444b Deleted: sha256:5b16e673d1b78ca9cfdf47b6bb2822f1bcce063f639c72be9bc322ea6537c64b Deleted: sha256:d2ce39fb3eb1e72e2afb84af79bc32c62f9ddce87a210fde7cd8b2d6431381dd Deleted: sha256:514a91a0af7f76eeb509d227e337364d33b2229043c051792d2051e36308b706 Deleted: sha256:29fa3773ea9f4b89842d2e75c8a1b68ac48b356e82f85c5cb4c7aac9738322cb Deleted: sha256:c0c3aece8b2a343d36ed7e0e7797668e033791756b76b5d591431e1faa8f59ef Build step 'Execute shell' marked build as failure Not sending mail to unregistered user [email protected]
