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 2018/12/14 23:30:11 UTC
Build failed in Jenkins: Mesos-Reviewbot #23606
See <https://builds.apache.org/job/Mesos-Reviewbot/23606/display/redirect?page=changes>
Changes:
[gregorywmann] Added HEARTBEAT events and calls for the executor HTTP API.
[gregorywmann] Refactored master and agent streaming connections.
[gregorywmann] Added heartbeaters for agent and HTTP executors.
[gregorywmann] Added tests for agent/executor heartbeating.
[gregorywmann] Changed master to hold subscribers in a circular buffer.
[gregorywmann] Added gauge metric for operator event stream subscribers.
------------------------------------------
[...truncated 46.51 MB...]
I1214 23:29:13.270529 19615 http.cpp:1157] HTTP POST for /master/api/v1/scheduler from 172.17.0.2:39846
I1214 23:29:13.270718 19615 master.cpp:5955] Processing REVIVE call for framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default)
I1214 23:29:13.271056 19781 hierarchical.cpp:1387] Revived offers for roles { * } of framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000
I1214 23:29:13.272805 19781 hierarchical.cpp:1566] Performed allocation for 1 agents in 1.567119ms
I1214 23:29:13.273218 19654 master.cpp:9537] Sending offers [ 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-O1 ] to framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default)
I1214 23:29:13.274749 19727 scheduler.cpp:845] Enqueuing event OFFERS received from http://172.17.0.2:39758/master/api/v1/scheduler
I1214 23:29:13.283938 19738 slave.cpp:922] Agent terminating
I1214 23:29:13.284391 19800 master.cpp:1392] Framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default) disconnected
I1214 23:29:13.284425 19800 master.cpp:3243] Deactivating framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default)
I1214 23:29:13.284906 19554 hierarchical.cpp:418] Deactivated framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000
W1214 23:29:13.285313 19800 master.hpp:2512] Unable to send message to framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default): connection closed
I1214 23:29:13.285358 19800 master.cpp:11543] Removing offer 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-O1
I1214 23:29:13.285431 19800 master.cpp:3220] Disconnecting framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default)
I1214 23:29:13.285466 19800 master.cpp:1407] Giving framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default) 0ns to failover
I1214 23:29:13.285688 19800 master.cpp:1277] Agent 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-S0 at slave(42)@172.17.0.2:39758 (d2402939f90c) disconnected
I1214 23:29:13.285720 19800 master.cpp:3280] Disconnecting agent 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-S0 at slave(42)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:13.285701 19554 hierarchical.cpp:1238] 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 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-S0 from framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000
I1214 23:29:13.285794 19800 master.cpp:3299] Deactivating agent 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-S0 at slave(42)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:13.285982 19800 hierarchical.cpp:801] Agent 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-S0 deactivated
I1214 23:29:13.287288 19792 master.cpp:9329] Framework failover timeout, removing framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default)
I1214 23:29:13.287319 19792 master.cpp:10269] Removing framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000 (default)
I1214 23:29:13.287901 19792 hierarchical.cpp:357] Removed framework 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-0000
I1214 23:29:13.311960 19666 master.cpp:1117] Master terminating
I1214 23:29:13.313249 19683 hierarchical.cpp:643] Removed agent 3e1c10d4-0937-4678-a7c5-38e76eaa7fb9-S0
[ OK ] ContentType/SchedulerTest.NoOffersOnReregistrationWithAllRolesSuppressed/0 (1014 ms)
[----------] 2 tests from ContentType/SchedulerTest (1086 ms total)
[----------] 1 test from ContentType/AgentResourceProviderConfigApiTest
[ RUN ] ContentType/AgentResourceProviderConfigApiTest.AddInvalid/0
I1214 23:29:13.339030 19303 cluster.cpp:173] Creating default 'local' authorizer
I1214 23:29:13.343158 19636 master.cpp:414] Master 570dac66-cf21-492a-8efb-0c56ad984494 (d2402939f90c) started on 172.17.0.2:39758
I1214 23:29:13.343236 19636 master.cpp:417] Flags at startup: --acls="" --agent_ping_timeout="15secs" --agent_reregister_timeout="10mins" --allocation_interval="50ms" --allocator="hierarchical" --authenticate_agents="true" --authenticate_frameworks="true" --authenticate_http_frameworks="true" --authenticate_http_readonly="true" --authenticate_http_readwrite="true" --authentication_v0_timeout="15secs" --authenticators="crammd5" --authorizers="local" --credentials="/tmp/C5YBcC/credentials" --filter_gpu_resources="true" --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_operator_event_stream_subscribers="1000" --max_unreachable_tasks_per_framework="1000" --memory_profiling="false" --min_allocatable_resources="cpus:0.01|mem:32" --port="5050" --publish_per_framework_metrics="true" --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" --require_agent_domain="false" --role_sorter="drf" --root_submissions="true" --version="false" --webui_dir="/mesos/mesos-1.8.0/_inst/share/mesos/webui" --work_dir="/tmp/C5YBcC/master" --zk_session_timeout="10secs"
I1214 23:29:13.343741 19636 master.cpp:466] Master only allowing authenticated frameworks to register
I1214 23:29:13.343782 19636 master.cpp:472] Master only allowing authenticated agents to register
I1214 23:29:13.343818 19636 master.cpp:478] Master only allowing authenticated HTTP frameworks to register
I1214 23:29:13.343869 19636 credentials.hpp:37] Loading credentials for authentication from '/tmp/C5YBcC/credentials'
I1214 23:29:13.344233 19636 master.cpp:522] Using default 'crammd5' authenticator
I1214 23:29:13.344460 19636 http.cpp:1017] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readonly'
I1214 23:29:13.345306 19636 http.cpp:1017] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readwrite'
I1214 23:29:13.345487 19636 http.cpp:1017] Creating default 'basic' HTTP authenticator for realm 'mesos-master-scheduler'
I1214 23:29:13.345652 19636 master.cpp:603] Authorization enabled
I1214 23:29:13.346264 19595 hierarchical.cpp:175] Initialized hierarchical allocator process
I1214 23:29:13.346387 19595 whitelist_watcher.cpp:77] No whitelist given
I1214 23:29:13.349763 19738 master.cpp:2091] Elected as the leading master!
I1214 23:29:13.349808 19738 master.cpp:1646] Recovering from registrar
I1214 23:29:13.350024 19666 registrar.cpp:339] Recovering registrar
I1214 23:29:13.350836 19666 registrar.cpp:383] Successfully fetched the registry (0B) in 761088ns
I1214 23:29:13.350971 19666 registrar.cpp:487] Applied 1 operations in 42624ns; attempting to update the registry
I1214 23:29:13.351889 19666 registrar.cpp:544] Successfully updated the registry in 851712ns
I1214 23:29:13.352025 19666 registrar.cpp:416] Successfully recovered registrar
I1214 23:29:13.352542 19700 master.cpp:1760] Recovered 0 agents from the registry (135B); allowing 10mins for agents to reregister
I1214 23:29:13.352691 19700 hierarchical.cpp:215] Skipping recovery of hierarchical allocator: nothing to recover
W1214 23:29:13.361048 19303 process.cpp:2829] Attempted to spawn already running process files@172.17.0.2:39758
I1214 23:29:13.364266 19303 containerizer.cpp:305] Using isolation { environment_secret, posix/cpu, posix/mem, filesystem/posix, network/cni }
W1214 23:29:13.365341 19303 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W1214 23:29:13.365481 19303 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1214 23:29:13.365523 19303 provisioner.cpp:298] Using default backend 'copy'
I1214 23:29:13.369333 19303 cluster.cpp:485] Creating default 'local' authorizer
I1214 23:29:13.371980 19535 slave.cpp:268] Mesos agent started on (43)@172.17.0.2:39758
I1214 23:29:13.372009 19535 slave.cpp:269] Flags at startup: --acls="" --appc_simple_discovery_uri_prefix="http://" --appc_store_dir="/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/store/appc" --authenticate_http_readonly="true" --authenticate_http_readwrite="false" --authenticatee="crammd5" --authentication_backoff_factor="1secs" --authentication_timeout_max="1mins" --authentication_timeout_min="5secs" --authorizer="local" --cgroups_cpu_enable_pids_and_tids_count="false" --cgroups_destroy_timeout="1mins" --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/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/credential" --default_role="*" --disallow_sharing_agent_pid_namespace="false" --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/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/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/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/fetch" --fetcher_cache_size="2GB" --fetcher_stall_timeout="1mins" --frameworks_home="/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/frameworks" --gc_delay="1weeks" --gc_disk_headroom="0.1" --gc_non_executor_container_sandboxes="false" --help="false" --hostname_lookup="true" --http_command_executor="false" --http_credentials="/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/mesos/mesos-1.8.0/_build/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --memory_profiling="false" --network_cni_metrics="true" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --port="5051" --qos_correction_interval_min="0ns" --quiet="false" --reconfiguration_policy="equal" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resource_provider_config_dir="/tmp/C5YBcC/resource_provider_configs" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r" --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/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_CsA791" --zk_session_timeout="10secs"
I1214 23:29:13.372588 19535 credentials.hpp:86] Loading credential for authentication from '/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/credential'
I1214 23:29:13.372809 19535 slave.cpp:301] Agent using credential for: test-principal
I1214 23:29:13.372833 19535 credentials.hpp:37] Loading credentials for authentication from '/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_KEOE7r/http_credentials'
I1214 23:29:13.373091 19535 http.cpp:1017] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1214 23:29:13.373474 19535 disk_profile_adaptor.cpp:80] Creating default disk profile adaptor module
I1214 23:29:13.375028 19535 slave.cpp:616] 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"}]
I1214 23:29:13.375316 19535 slave.cpp:624] Agent attributes: [ ]
I1214 23:29:13.375334 19535 slave.cpp:633] Agent hostname: d2402939f90c
I1214 23:29:13.375528 19636 task_status_update_manager.cpp:181] Pausing sending task status updates
I1214 23:29:13.375582 19636 status_update_manager_process.hpp:379] Pausing operation status update manager
I1214 23:29:13.377291 19465 state.cpp:66] Recovering state from '/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_CsA791/meta'
I1214 23:29:13.377610 19781 slave.cpp:7004] Finished recovering checkpointed state from '/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_CsA791/meta', beginning agent recovery
I1214 23:29:13.377826 19781 task_status_update_manager.cpp:207] Recovering task status update manager
I1214 23:29:13.378193 19771 containerizer.cpp:727] Recovering Mesos containers
I1214 23:29:13.378569 19771 containerizer.cpp:1053] Recovering isolators
I1214 23:29:13.382907 19615 containerizer.cpp:1092] Recovering provisioner
I1214 23:29:13.387104 19751 provisioner.cpp:494] Provisioner recovery complete
I1214 23:29:13.388322 19727 composing.cpp:339] Finished recovering all containerizers
I1214 23:29:13.388526 19700 slave.cpp:7233] Recovering executors
I1214 23:29:13.388651 19700 slave.cpp:7386] Finished recovery
I1214 23:29:13.389828 19554 slave.cpp:1268] New master detected at master@172.17.0.2:39758
I1214 23:29:13.389906 19554 slave.cpp:1333] Detecting new master
I1214 23:29:13.390089 19615 task_status_update_manager.cpp:181] Pausing sending task status updates
I1214 23:29:13.390105 19554 status_update_manager_process.hpp:379] Pausing operation status update manager
I1214 23:29:13.398864 19762 slave.cpp:1360] Authenticating with master master@172.17.0.2:39758
I1214 23:29:13.399011 19762 slave.cpp:1369] Using default CRAM-MD5 authenticatee
I1214 23:29:13.399248 19500 hierarchical.cpp:1566] Performed allocation for 0 agents in 85920ns
I1214 23:29:13.399390 19636 authenticatee.cpp:121] Creating new client SASL connection
I1214 23:29:13.399796 19500 master.cpp:9722] Authenticating slave(43)@172.17.0.2:39758
I1214 23:29:13.400063 19500 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(72)@172.17.0.2:39758
I1214 23:29:13.400559 19500 authenticator.cpp:98] Creating new server SASL connection
I1214 23:29:13.400858 19781 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5
I1214 23:29:13.400892 19781 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5'
I1214 23:29:13.401026 19683 authenticator.cpp:204] Received SASL authentication start
I1214 23:29:13.401106 19683 authenticator.cpp:326] Authentication requires more steps
I1214 23:29:13.401230 19683 authenticatee.cpp:259] Received SASL authentication step
I1214 23:29:13.401361 19683 authenticator.cpp:232] Received SASL authentication step
I1214 23:29:13.401396 19683 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'd2402939f90c' server FQDN: 'd2402939f90c' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false
I1214 23:29:13.401417 19683 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I1214 23:29:13.401468 19683 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I1214 23:29:13.401504 19683 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: 'd2402939f90c' server FQDN: 'd2402939f90c' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true
I1214 23:29:13.401523 19683 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true
I1214 23:29:13.401536 19683 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true
I1214 23:29:13.401561 19683 authenticator.cpp:318] Authentication success
I1214 23:29:13.401839 19683 authenticatee.cpp:299] Authentication success
I1214 23:29:13.401998 19666 master.cpp:9754] Successfully authenticated principal 'test-principal' at slave(43)@172.17.0.2:39758
I1214 23:29:13.402113 19517 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(72)@172.17.0.2:39758
I1214 23:29:13.402505 19683 slave.cpp:1460] Successfully authenticated with master master@172.17.0.2:39758
I1214 23:29:13.403013 19683 slave.cpp:1893] Will retry registration in 1.794779ms if necessary
I1214 23:29:13.403383 19683 master.cpp:6607] Received register agent message from slave(43)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:13.403764 19683 master.cpp:3937] Authorizing agent providing resources 'cpus:2; mem:1024; disk:1024; ports:[31000-32000]' with principal 'test-principal'
I1214 23:29:13.404520 19636 master.cpp:6674] Authorized registration of agent at slave(43)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:13.404628 19636 master.cpp:6789] Registering agent at slave(43)@172.17.0.2:39758 (d2402939f90c) with id 570dac66-cf21-492a-8efb-0c56ad984494-S0
I1214 23:29:13.405354 19636 registrar.cpp:487] Applied 1 operations in 233630ns; attempting to update the registry
I1214 23:29:13.406116 19636 registrar.cpp:544] Successfully updated the registry in 683008ns
I1214 23:29:13.406319 19465 slave.cpp:1893] Will retry registration in 19.206823ms if necessary
I1214 23:29:13.406425 19636 master.cpp:6837] Admitted agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:13.407354 19636 master.cpp:6882] Registered agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c) with cpus:2; mem:1024; disk:1024; ports:[31000-32000]
I1214 23:29:13.407650 19727 slave.cpp:1493] Registered with master master@172.17.0.2:39758; given agent ID 570dac66-cf21-492a-8efb-0c56ad984494-S0
I1214 23:29:13.407744 19809 hierarchical.cpp:603] Added agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 (d2402939f90c) with cpus:2; mem:1024; disk:1024; ports:[31000-32000] (allocated: {})
I1214 23:29:13.408097 19809 hierarchical.cpp:1566] Performed allocation for 1 agents in 139944ns
I1214 23:29:13.408159 19727 slave.cpp:1514] Checkpointing SlaveInfo to '/tmp/ContentType_AgentResourceProviderConfigApiTest_AddInvalid_0_CsA791/meta/slaves/570dac66-cf21-492a-8efb-0c56ad984494-S0/slave.info'
I1214 23:29:13.408365 19771 task_status_update_manager.cpp:188] Resuming sending task status updates
I1214 23:29:13.408690 19809 status_update_manager_process.hpp:385] Resuming operation status update manager
I1214 23:29:13.408942 19636 master.cpp:6607] Received register agent message from slave(43)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:13.409322 19636 master.cpp:3937] Authorizing agent providing resources 'cpus:2; mem:1024; disk:1024; ports:[31000-32000]' with principal 'test-principal'
I1214 23:29:13.409297 19727 slave.cpp:1563] Forwarding agent update {"operations":{},"resource_providers":{},"resource_version_uuid":{"value":"Aeq7GaacRO214hnbh+NAww=="},"slave_id":{"value":"570dac66-cf21-492a-8efb-0c56ad984494-S0"},"update_oversubscribed_resources":false}
I1214 23:29:13.410485 19636 master.cpp:7941] Ignoring update on agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c) as it reports no changes
I1214 23:29:13.410588 19636 master.cpp:6674] Authorized registration of agent at slave(43)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:13.410694 19636 master.cpp:6768] Agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c) already registered, resending acknowledgement
W1214 23:29:13.410908 19636 slave.cpp:1545] Already registered with master master@172.17.0.2:39758
I1214 23:29:13.411010 19636 slave.cpp:1563] Forwarding agent update {"operations":{},"resource_providers":{},"resource_version_uuid":{"value":"Aeq7GaacRO214hnbh+NAww=="},"slave_id":{"value":"570dac66-cf21-492a-8efb-0c56ad984494-S0"},"update_oversubscribed_resources":false}
I1214 23:29:13.412314 19636 master.cpp:7941] Ignoring update on agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c) as it reports no changes
I1214 23:29:13.418007 19771 process.cpp:3588] Handling HTTP event for process 'slave(43)' with path: '/slave(43)/api/v1'
I1214 23:29:13.419095 19615 http.cpp:1157] HTTP POST for /slave(43)/api/v1 from 172.17.0.2:39868
I1214 23:29:13.421193 19615 http.cpp:3248] Processing UPDATE_RESOURCE_PROVIDER_CONFIG call with type 'org.apache.mesos.rp.local.storage' and name 'test'
I1214 23:29:13.427031 19666 slave.cpp:922] Agent terminating
I1214 23:29:13.453074 19683 hierarchical.cpp:1566] Performed allocation for 1 agents in 164971ns
I1214 23:29:13.504981 19465 hierarchical.cpp:1566] Performed allocation for 1 agents in 162798ns
I1214 23:29:13.556238 19615 hierarchical.cpp:1566] Performed allocation for 1 agents in 167382ns
I1214 23:29:13.608064 19713 hierarchical.cpp:1566] Performed allocation for 1 agents in 133935ns
I1214 23:29:13.658996 19751 hierarchical.cpp:1566] Performed allocation for 1 agents in 107801ns
I1214 23:29:13.709774 19575 hierarchical.cpp:1566] Performed allocation for 1 agents in 136919ns
I1214 23:29:13.763685 19738 hierarchical.cpp:1566] Performed allocation for 1 agents in 158858ns
I1214 23:29:13.815639 19654 hierarchical.cpp:1566] Performed allocation for 1 agents in 159942ns
I1214 23:29:13.867231 19500 hierarchical.cpp:1566] Performed allocation for 1 agents in 152839ns
I1214 23:29:13.918889 19771 hierarchical.cpp:1566] Performed allocation for 1 agents in 183733ns
I1214 23:29:13.970129 19636 hierarchical.cpp:1566] Performed allocation for 1 agents in 139597ns
I1214 23:29:14.021291 19800 hierarchical.cpp:1566] Performed allocation for 1 agents in 165721ns
I1214 23:29:14.073110 19535 hierarchical.cpp:1566] Performed allocation for 1 agents in 145765ns
I1214 23:29:14.125072 19700 hierarchical.cpp:1566] Performed allocation for 1 agents in 167060ns
I1214 23:29:14.176261 19484 hierarchical.cpp:1566] Performed allocation for 1 agents in 138286ns
I1214 23:29:14.227485 19762 hierarchical.cpp:1566] Performed allocation for 1 agents in 159496ns
I1214 23:29:14.278671 19465 hierarchical.cpp:1566] Performed allocation for 1 agents in 135082ns
I1214 23:29:14.330528 19595 hierarchical.cpp:1566] Performed allocation for 1 agents in 139669ns
I1214 23:29:14.360500 19554 master.cpp:1277] Agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c) disconnected
I1214 23:29:14.360539 19554 master.cpp:3280] Disconnecting agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:14.360599 19554 master.cpp:3299] Deactivating agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 at slave(43)@172.17.0.2:39758 (d2402939f90c)
I1214 23:29:14.360733 19727 hierarchical.cpp:801] Agent 570dac66-cf21-492a-8efb-0c56ad984494-S0 deactivated
I1214 23:29:14.369282 19575 master.cpp:1117] Master terminating
I1214 23:29:14.370105 19738 hierarchical.cpp:643] Removed agent 570dac66-cf21-492a-8efb-0c56ad984494-S0
[ OK ] ContentType/AgentResourceProviderConfigApiTest.AddInvalid/0 (1038 ms)
[----------] 1 test from ContentType/AgentResourceProviderConfigApiTest (1039 ms total)
[----------] Global test environment tear-down
[==========] 87 tests from 64 test cases ran. (91425 ms total)
[ PASSED ] 86 tests.
[ FAILED ] 1 test, listed below:
[ FAILED ] DiskQuotaTest.SlaveRecovery
1 FAILED TEST
YOU HAVE 24 DISABLED TESTS
I1214 23:29:14.459128 19824 process.cpp:927] Stopped the socket accept loop
[FAIL]: 1 shard(s) have failed tests
make[4]: *** [check-local] Error 1
make[4]: Leaving directory `/mesos/mesos-1.8.0/_build/src'
make[3]: *** [check-am] Error 2
make[3]: Leaving directory `/mesos/mesos-1.8.0/_build/src'
make[2]: *** [check] Error 2
make[2]: Leaving directory `/mesos/mesos-1.8.0/_build/src'
make[1]: *** [check-recursive] Error 1
make[1]: Leaving directory `/mesos/mesos-1.8.0/_build'
make: *** [distcheck] Error 1
+ docker rmi --force mesos-1544826079-11600
Untagged: mesos-1544826079-11600:latest
Deleted: sha256:c752d388cbe488d738ae14b60602f8f0bd91cb0fc352b295dc8ba6e4a04905f0
Deleted: sha256:51ccac184e57834849338b60196faf9e239a5d9c3b28c04d41ca1574ce659b09
Deleted: sha256:7373daf2b6a023329cb4fbadc9dd2e4b5813d17ef81adb5af9cc21c8291f419d
Deleted: sha256:b2d1a28972715701389246e3e00727954664e77b08ee611ff5c4e390682ca819
Deleted: sha256:9a73ba8c0726a6f75edd4ad0ffd52a9e6706a2282990b199909b09fdf77b07e5
Deleted: sha256:5009a6e0b29b89e0056f73608812177d4b6d7827e1a42e901626dfb1a313ac01
Deleted: sha256:474fe2b2ab460645ae397b5324af87e4580d451d0dc290d362441f7dd63a2dac
Deleted: sha256:ea498d16608fc6122493a9f7f02ebbed3c4ef4bbf045294f71f5b706e8f3c97c
Deleted: sha256:7dcd503dc451024a2d8f2bfe8efe007295bae898930ffd9dd60a507687d057e8
Deleted: sha256:cf12e49eb56d6d2764221cd04777cb80b1d26ecea728852ea20be2544d0b56d9
Deleted: sha256:6541c7e5cb883f5367633f85a58a3dcaada7fb2fb20ef1ba60e35c691e3dada3
Deleted: sha256:1e2869456f265d89c51b977749092968d9df620c8b581773fbbaa59462fe3448
Deleted: sha256:1bbe054630cc69345f3f66b2d2eb0736602b3e200b144c98c04c472caf592118
Deleted: sha256:4e9c738d24dc3edd0a93aa2d16cb986955b0cc1f6a97a901f7c11ffd54691fdd
Deleted: sha256:fce781cb3b3a597cd3aec3393a04e1869c02a656afc64f0742d7f0df81918a80
Deleted: sha256:997190ad8b9481c1c8bc5e5ace01ae44fae6c784a6e468a4b0c4111f1d6b2231
Deleted: sha256:f3345ef3f2a1588ba48cc781c267a5f3c973670b556f2e945504a118d8823b1c
Deleted: sha256:7f4e1c58d4dbc35998def70810eb77ed9f21d6d22b861331e5a17bce75b19e20
Deleted: sha256:71937681ca485c94c5fbd34ec32a9b1250aa184034ce48e75e82bd9ca81eee5b
Deleted: sha256:6dcfc82e5b441bdf03540e6c08e3517a6f57c58365a440c0f99624fa0a4474e1
Deleted: sha256:0728a5e648006877de89d107747bee969bcb95045716415d3eddd04418310bfe
Deleted: sha256:aa759d49765167cd8bff7b3921fe8f746e2f48529f455dc63376486e807b00af
Deleted: sha256:16368b4c83806454809838fb024edd6b68ad959c28dde75f25d55056a15e40a7
Deleted: sha256:c501a9e94c9e2ad666e93c1f93d6ad7f1883b4df63b9dea937dc4ee4891376e7
Deleted: sha256:74f1cfc54c3cffd97d5b9ea099bc51b14131a54336a56456727e1f7b72e2766d
Deleted: sha256:bd8c0434eee08c09bbd6d7f462610744e6a604959059b94dc2675d6150a40006
Deleted: sha256:70e9acc1346a6ca8b456355eec025fb570a6cbed4512ddfdcb5fe8aa20ac5493
Deleted: sha256:a1d6fcc877193f4474bc6cd39806999f8fff97bb8b36a215a1062d87d0c89447
Deleted: sha256:f0b2573c6d13e6a4b37211f36c72d33cabc9a6c1b78011efd603fa8ec86135d7
Deleted: sha256:f3b0e49ddc7d09d89cd94f35234cc65f4a02140fb419bb73eab937c9887199be
12-14-18_22:21:15 - Running <https://builds.apache.org/job/Mesos-Reviewbot/ws/support/verify-reviews.py>
Checking if review 69338 needs verification
Latest review timestamp: 2018-12-14 06:36:29
Latest diff timestamp: 2018-12-14 15:55:54
This patch has been updated since its last review, needs verification.
Dependent review: https://reviews.apache.org/api/review-requests/69337/
Verifying review 69338
Dependent review: https://reviews.apache.org/api/review-requests/69337/
Applying review 69337
/usr/bin/python3 support/apply-reviews.py -n -r 69337
Applying review 69338
/usr/bin/python3 support/apply-reviews.py -n -r 69338
Traceback (most recent call last):
File "<https://builds.apache.org/job/Mesos-Reviewbot/ws/support/verify-reviews.py",> line 186, in verify_review
% (command, build_output)])
File "/usr/lib/python3.5/subprocess.py", line 581, in check_call
raise CalledProcessError(retcode, cmd)
subprocess.CalledProcessError: Command '['bash', '-c', "set -o pipefail; export OS='ubuntu:14.04' BUILDTOOL='autotools' COMPILER='gcc' CONFIGURATION='--verbose --disable-libtool-wrappers' ENVIRONMENT='GLOG_v=1 MESOS_VERBOSE=1'; ./support/docker-build.sh 2>&1 | tee build_69338"]' returned non-zero exit status 2
During handling of the above exception, another exception occurred:
Traceback (most recent call last):
File "<https://builds.apache.org/job/Mesos-Reviewbot/ws/support/verify-reviews.py",> line 294, in <module>
main()
File "<https://builds.apache.org/job/Mesos-Reviewbot/ws/support/verify-reviews.py",> line 288, in main
verify_review(review_request, handler)
File "<https://builds.apache.org/job/Mesos-Reviewbot/ws/support/verify-reviews.py",> line 201, in verify_review
output = open(build_output).read().decode(sys.stdout.encoding)
AttributeError: 'str' object has no attribute 'decode'
Build step 'Execute shell' marked build as failure
Jenkins build is back to normal : Mesos-Reviewbot #23608
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos-Reviewbot/23608/display/redirect?page=changes>
Build failed in Jenkins: Mesos-Reviewbot #23607
Posted by Apache Jenkins Server <je...@builds.apache.org>.
See <https://builds.apache.org/job/Mesos-Reviewbot/23607/display/redirect?page=changes>
Changes:
[toenshoff] Refactored createAuthorizationCallbacks into common/authorization.
------------------------------------------
[...truncated 42.13 MB...]
I1217 15:57:58.408349 54863 master.cpp:1646] Recovering from registrar
I1217 15:57:58.408519 54847 registrar.cpp:339] Recovering registrar
I1217 15:57:58.409366 54847 registrar.cpp:383] Successfully fetched the registry (0B) in 796928ns
I1217 15:57:58.409530 54847 registrar.cpp:487] Applied 1 operations in 55570ns; attempting to update the registry
I1217 15:57:58.410357 54847 registrar.cpp:544] Successfully updated the registry in 749824ns
I1217 15:57:58.410517 54847 registrar.cpp:416] Successfully recovered registrar
I1217 15:57:58.411068 54856 master.cpp:1760] Recovered 0 agents from the registry (135B); allowing 10mins for agents to reregister
I1217 15:57:58.411135 54844 hierarchical.cpp:215] Skipping recovery of hierarchical allocator: nothing to recover
W1217 15:57:58.416739 54842 process.cpp:2829] Attempted to spawn already running process files@172.17.0.2:36305
I1217 15:57:58.418292 54842 containerizer.cpp:305] Using isolation { environment_secret, posix/cpu, posix/mem, filesystem/posix, network/cni }
W1217 15:57:58.419036 54842 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W1217 15:57:58.419078 54842 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1217 15:57:58.419113 54842 provisioner.cpp:298] Using default backend 'copy'
I1217 15:57:58.421972 54842 cluster.cpp:486] Creating default 'local' authorizer
I1217 15:57:58.424571 54853 slave.cpp:268] Mesos agent started on (1066)@172.17.0.2:36305
I1217 15:57:58.424600 54853 slave.cpp:269] Flags at startup: --acls="" --appc_simple_discovery_uri_prefix="http://" --appc_store_dir="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/store/appc" --authenticate_http_readonly="true" --authenticate_http_readwrite="false" --authenticatee="crammd5" --authentication_backoff_factor="1secs" --authentication_timeout_max="1mins" --authentication_timeout_min="5secs" --authorizer="local" --cgroups_cpu_enable_pids_and_tids_count="false" --cgroups_destroy_timeout="1mins" --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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/credential" --default_role="*" --disallow_sharing_agent_pid_namespace="false" --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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/fetch" --fetcher_cache_size="2GB" --fetcher_stall_timeout="1mins" --frameworks_home="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/frameworks" --gc_delay="1weeks" --gc_disk_headroom="0.1" --gc_non_executor_container_sandboxes="false" --help="false" --hostname_lookup="true" --http_command_executor="false" --http_credentials="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/tmp/SRC/build/mesos-1.8.0/_build/sub/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --memory_profiling="false" --network_cni_metrics="true" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --port="5051" --qos_correction_interval_min="0ns" --quiet="false" --reconfiguration_policy="equal" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resource_provider_config_dir="/tmp/Ji0XLy/resource_provider_configs" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE" --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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ECddC6" --zk_session_timeout="10secs"
I1217 15:57:58.425060 54853 credentials.hpp:86] Loading credential for authentication from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/credential'
I1217 15:57:58.425258 54853 slave.cpp:301] Agent using credential for: test-principal
I1217 15:57:58.425285 54853 credentials.hpp:37] Loading credentials for authentication from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ZpmtsE/http_credentials'
I1217 15:57:58.425523 54853 http.cpp:965] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1217 15:57:58.425890 54853 disk_profile_adaptor.cpp:80] Creating default disk profile adaptor module
I1217 15:57:58.427258 54853 slave.cpp:616] 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"}]
I1217 15:57:58.427495 54853 slave.cpp:624] Agent attributes: [ ]
I1217 15:57:58.427515 54853 slave.cpp:633] Agent hostname: 85259784eebc
I1217 15:57:58.427672 54863 status_update_manager_process.hpp:379] Pausing operation status update manager
I1217 15:57:58.427729 54860 task_status_update_manager.cpp:181] Pausing sending task status updates
I1217 15:57:58.429314 54855 state.cpp:66] Recovering state from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ECddC6/meta'
I1217 15:57:58.429597 54866 slave.cpp:7004] Finished recovering checkpointed state from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ECddC6/meta', beginning agent recovery
I1217 15:57:58.429786 54858 task_status_update_manager.cpp:207] Recovering task status update manager
I1217 15:57:58.430133 54843 containerizer.cpp:727] Recovering Mesos containers
I1217 15:57:58.430493 54843 containerizer.cpp:1053] Recovering isolators
I1217 15:57:58.431115 54851 containerizer.cpp:1092] Recovering provisioner
I1217 15:57:58.431867 54859 provisioner.cpp:494] Provisioner recovery complete
I1217 15:57:58.432624 54866 composing.cpp:339] Finished recovering all containerizers
I1217 15:57:58.432807 54858 slave.cpp:7233] Recovering executors
I1217 15:57:58.432965 54858 slave.cpp:7386] Finished recovery
I1217 15:57:58.433830 54857 task_status_update_manager.cpp:181] Pausing sending task status updates
I1217 15:57:58.433861 54856 status_update_manager_process.hpp:379] Pausing operation status update manager
I1217 15:57:58.433885 54848 slave.cpp:1268] New master detected at master@172.17.0.2:36305
I1217 15:57:58.433960 54848 slave.cpp:1333] Detecting new master
I1217 15:57:58.444118 54844 slave.cpp:1360] Authenticating with master master@172.17.0.2:36305
I1217 15:57:58.444226 54844 slave.cpp:1369] Using default CRAM-MD5 authenticatee
I1217 15:57:58.444591 54843 authenticatee.cpp:121] Creating new client SASL connection
I1217 15:57:58.444949 54845 master.cpp:9691] Authenticating slave(1066)@172.17.0.2:36305
I1217 15:57:58.445119 54851 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(1858)@172.17.0.2:36305
I1217 15:57:58.445425 54849 authenticator.cpp:98] Creating new server SASL connection
I1217 15:57:58.445773 54863 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5
I1217 15:57:58.445818 54863 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5'
I1217 15:57:58.445950 54863 authenticator.cpp:204] Received SASL authentication start
I1217 15:57:58.446028 54863 authenticator.cpp:326] Authentication requires more steps
I1217 15:57:58.446173 54852 authenticatee.cpp:259] Received SASL authentication step
I1217 15:57:58.446339 54860 authenticator.cpp:232] Received SASL authentication step
I1217 15:57:58.446382 54860 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '85259784eebc' server FQDN: '85259784eebc' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false
I1217 15:57:58.446400 54860 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I1217 15:57:58.446449 54860 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I1217 15:57:58.446477 54860 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '85259784eebc' server FQDN: '85259784eebc' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true
I1217 15:57:58.446492 54860 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true
I1217 15:57:58.446504 54860 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true
I1217 15:57:58.446524 54860 authenticator.cpp:318] Authentication success
I1217 15:57:58.446624 54853 authenticatee.cpp:299] Authentication success
I1217 15:57:58.446810 54854 master.cpp:9723] Successfully authenticated principal 'test-principal' at slave(1066)@172.17.0.2:36305
I1217 15:57:58.446815 54865 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(1858)@172.17.0.2:36305
I1217 15:57:58.447041 54855 slave.cpp:1460] Successfully authenticated with master master@172.17.0.2:36305
I1217 15:57:58.447480 54855 slave.cpp:1893] Will retry registration in 5.156413ms if necessary
I1217 15:57:58.447683 54846 master.cpp:6607] Received register agent message from slave(1066)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.448061 54846 master.cpp:3937] Authorizing agent providing resources 'cpus:2; mem:1024; disk:1024; ports:[31000-32000]' with principal 'test-principal'
I1217 15:57:58.448812 54848 master.cpp:6674] Authorized registration of agent at slave(1066)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.448910 54848 master.cpp:6789] Registering agent at slave(1066)@172.17.0.2:36305 (85259784eebc) with id ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0
I1217 15:57:58.449584 54862 registrar.cpp:487] Applied 1 operations in 250867ns; attempting to update the registry
I1217 15:57:58.450242 54862 registrar.cpp:544] Successfully updated the registry in 587008ns
I1217 15:57:58.450422 54849 master.cpp:6837] Admitted agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 at slave(1066)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.451181 54849 master.cpp:6882] Registered agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 at slave(1066)@172.17.0.2:36305 (85259784eebc) with cpus:2; mem:1024; disk:1024; ports:[31000-32000]
I1217 15:57:58.451395 54863 slave.cpp:1493] Registered with master master@172.17.0.2:36305; given agent ID ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0
I1217 15:57:58.451476 54859 hierarchical.cpp:603] Added agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 (85259784eebc) with cpus:2; mem:1024; disk:1024; ports:[31000-32000] (allocated: {})
I1217 15:57:58.451522 54847 task_status_update_manager.cpp:188] Resuming sending task status updates
I1217 15:57:58.451550 54866 status_update_manager_process.hpp:385] Resuming operation status update manager
I1217 15:57:58.451773 54859 hierarchical.cpp:1566] Performed allocation for 1 agents in 106064ns
I1217 15:57:58.451804 54863 slave.cpp:1514] Checkpointing SlaveInfo to '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_0_ECddC6/meta/slaves/ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0/slave.info'
I1217 15:57:58.452956 54863 slave.cpp:1563] Forwarding agent update {"operations":{},"resource_version_uuid":{"value":"ZGXiYbDBTc6rkEBrXwdJ6Q=="},"slave_id":{"value":"ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0"},"update_oversubscribed_resources":false}
I1217 15:57:58.453610 54848 master.cpp:7941] Ignoring update on agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 at slave(1066)@172.17.0.2:36305 (85259784eebc) as it reports no changes
I1217 15:57:58.455402 54851 process.cpp:3588] Handling HTTP event for process 'slave(1066)' with path: '/slave(1066)/api/v1'
I1217 15:57:58.456611 54853 http.cpp:1105] HTTP POST for /slave(1066)/api/v1 from 172.17.0.2:60116
I1217 15:57:58.457254 54858 hierarchical.cpp:1566] Performed allocation for 1 agents in 105161ns
I1217 15:57:58.457904 54859 http.cpp:3293] Processing REMOVE_RESOURCE_PROVIDER_CONFIG call with type 'org.apache.mesos.rp.local.storage' and name 'test'
I1217 15:57:58.459537 54851 slave.cpp:922] Agent terminating
I1217 15:57:58.507860 54853 hierarchical.cpp:1566] Performed allocation for 1 agents in 83594ns
I1217 15:57:58.558908 54859 hierarchical.cpp:1566] Performed allocation for 1 agents in 144231ns
I1217 15:57:58.610442 54856 hierarchical.cpp:1566] Performed allocation for 1 agents in 149299ns
I1217 15:57:58.662268 54846 hierarchical.cpp:1566] Performed allocation for 1 agents in 145432ns
I1217 15:57:58.680639 54848 master.cpp:1277] Agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 at slave(1066)@172.17.0.2:36305 (85259784eebc) disconnected
I1217 15:57:58.680698 54848 master.cpp:3280] Disconnecting agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 at slave(1066)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.680770 54848 master.cpp:3299] Deactivating agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 at slave(1066)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.681020 54845 hierarchical.cpp:801] Agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0 deactivated
I1217 15:57:58.693274 54842 master.cpp:1117] Master terminating
I1217 15:57:58.694718 54848 hierarchical.cpp:643] Removed agent ad7f89a6-f976-4ccf-b5a2-d34cd49904d9-S0
[ OK ] ContentType/AgentResourceProviderConfigApiTest.IdempotentRemove/0 (304 ms)
[ RUN ] ContentType/AgentResourceProviderConfigApiTest.IdempotentRemove/1
I1217 15:57:58.703584 54842 cluster.cpp:174] Creating default 'local' authorizer
I1217 15:57:58.706648 54848 master.cpp:414] Master d7e439a6-f18a-481c-a36f-e2d4ba1ca777 (85259784eebc) started on 172.17.0.2:36305
I1217 15:57:58.706683 54848 master.cpp:417] Flags at startup: --acls="" --agent_ping_timeout="15secs" --agent_reregister_timeout="10mins" --allocation_interval="50ms" --allocator="hierarchical" --authenticate_agents="true" --authenticate_frameworks="true" --authenticate_http_frameworks="true" --authenticate_http_readonly="true" --authenticate_http_readwrite="true" --authentication_v0_timeout="15secs" --authenticators="crammd5" --authorizers="local" --credentials="/tmp/xzGTLi/credentials" --filter_gpu_resources="true" --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_operator_event_stream_subscribers="1000" --max_unreachable_tasks_per_framework="1000" --memory_profiling="false" --min_allocatable_resources="cpus:0.01|mem:32" --port="5050" --publish_per_framework_metrics="true" --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" --require_agent_domain="false" --role_sorter="drf" --root_submissions="true" --version="false" --webui_dir="/tmp/SRC/build/mesos-1.8.0/_inst/share/mesos/webui" --work_dir="/tmp/xzGTLi/master" --zk_session_timeout="10secs"
I1217 15:57:58.707060 54848 master.cpp:466] Master only allowing authenticated frameworks to register
I1217 15:57:58.707077 54848 master.cpp:472] Master only allowing authenticated agents to register
I1217 15:57:58.707088 54848 master.cpp:478] Master only allowing authenticated HTTP frameworks to register
I1217 15:57:58.707100 54848 credentials.hpp:37] Loading credentials for authentication from '/tmp/xzGTLi/credentials'
I1217 15:57:58.707394 54848 master.cpp:522] Using default 'crammd5' authenticator
I1217 15:57:58.707581 54848 http.cpp:965] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readonly'
I1217 15:57:58.707779 54848 http.cpp:965] Creating default 'basic' HTTP authenticator for realm 'mesos-master-readwrite'
I1217 15:57:58.707933 54848 http.cpp:965] Creating default 'basic' HTTP authenticator for realm 'mesos-master-scheduler'
I1217 15:57:58.708088 54848 master.cpp:603] Authorization enabled
I1217 15:57:58.708624 54851 hierarchical.cpp:175] Initialized hierarchical allocator process
I1217 15:57:58.708657 54855 whitelist_watcher.cpp:77] No whitelist given
I1217 15:57:58.711585 54847 master.cpp:2091] Elected as the leading master!
I1217 15:57:58.711622 54847 master.cpp:1646] Recovering from registrar
I1217 15:57:58.711799 54849 registrar.cpp:339] Recovering registrar
I1217 15:57:58.712597 54849 registrar.cpp:383] Successfully fetched the registry (0B) in 751872ns
I1217 15:57:58.712736 54849 registrar.cpp:487] Applied 1 operations in 40877ns; attempting to update the registry
I1217 15:57:58.713491 54849 registrar.cpp:544] Successfully updated the registry in 623872ns
I1217 15:57:58.713645 54849 registrar.cpp:416] Successfully recovered registrar
I1217 15:57:58.714143 54857 master.cpp:1760] Recovered 0 agents from the registry (135B); allowing 10mins for agents to reregister
I1217 15:57:58.714186 54863 hierarchical.cpp:215] Skipping recovery of hierarchical allocator: nothing to recover
W1217 15:57:58.721105 54842 process.cpp:2829] Attempted to spawn already running process files@172.17.0.2:36305
I1217 15:57:58.722765 54842 containerizer.cpp:305] Using isolation { environment_secret, posix/cpu, posix/mem, filesystem/posix, network/cni }
W1217 15:57:58.723412 54842 backend.cpp:76] Failed to create 'aufs' backend: AufsBackend requires root privileges
W1217 15:57:58.723443 54842 backend.cpp:76] Failed to create 'bind' backend: BindBackend requires root privileges
I1217 15:57:58.723481 54842 provisioner.cpp:298] Using default backend 'copy'
I1217 15:57:58.726477 54842 cluster.cpp:486] Creating default 'local' authorizer
I1217 15:57:58.728984 54861 slave.cpp:268] Mesos agent started on (1067)@172.17.0.2:36305
I1217 15:57:58.729010 54861 slave.cpp:269] Flags at startup: --acls="" --appc_simple_discovery_uri_prefix="http://" --appc_store_dir="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/store/appc" --authenticate_http_readonly="true" --authenticate_http_readwrite="false" --authenticatee="crammd5" --authentication_backoff_factor="1secs" --authentication_timeout_max="1mins" --authentication_timeout_min="5secs" --authorizer="local" --cgroups_cpu_enable_pids_and_tids_count="false" --cgroups_destroy_timeout="1mins" --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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/credential" --default_role="*" --disallow_sharing_agent_pid_namespace="false" --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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/fetch" --fetcher_cache_size="2GB" --fetcher_stall_timeout="1mins" --frameworks_home="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/frameworks" --gc_delay="1weeks" --gc_disk_headroom="0.1" --gc_non_executor_container_sandboxes="false" --help="false" --hostname_lookup="true" --http_command_executor="false" --http_credentials="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/http_credentials" --http_heartbeat_interval="30secs" --initialize_driver_logging="true" --isolation="posix/cpu,posix/mem" --launcher="posix" --launcher_dir="/tmp/SRC/build/mesos-1.8.0/_build/sub/src" --logbufsecs="0" --logging_level="INFO" --max_completed_executors_per_framework="150" --memory_profiling="false" --network_cni_metrics="true" --oversubscribed_resources_interval="15secs" --perf_duration="10secs" --perf_interval="1mins" --port="5051" --qos_correction_interval_min="0ns" --quiet="false" --reconfiguration_policy="equal" --recover="reconnect" --recovery_timeout="15mins" --registration_backoff_factor="10ms" --resource_provider_config_dir="/tmp/xzGTLi/resource_provider_configs" --resources="cpus:2;gpus:0;mem:1024;disk:1024;ports:[31000-32000]" --revocable_cpu_low_priority="true" --runtime_dir="/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp" --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/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_MwIcjR" --zk_session_timeout="10secs"
I1217 15:57:58.729583 54861 credentials.hpp:86] Loading credential for authentication from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/credential'
I1217 15:57:58.729822 54861 slave.cpp:301] Agent using credential for: test-principal
I1217 15:57:58.729849 54861 credentials.hpp:37] Loading credentials for authentication from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_HdXwQp/http_credentials'
I1217 15:57:58.730170 54861 http.cpp:965] Creating default 'basic' HTTP authenticator for realm 'mesos-agent-readonly'
I1217 15:57:58.730552 54861 disk_profile_adaptor.cpp:80] Creating default disk profile adaptor module
I1217 15:57:58.731987 54861 slave.cpp:616] 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"}]
I1217 15:57:58.732224 54861 slave.cpp:624] Agent attributes: [ ]
I1217 15:57:58.732244 54861 slave.cpp:633] Agent hostname: 85259784eebc
I1217 15:57:58.732399 54852 status_update_manager_process.hpp:379] Pausing operation status update manager
I1217 15:57:58.732420 54847 task_status_update_manager.cpp:181] Pausing sending task status updates
I1217 15:57:58.734045 54864 state.cpp:66] Recovering state from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_MwIcjR/meta'
I1217 15:57:58.734293 54853 slave.cpp:7004] Finished recovering checkpointed state from '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_MwIcjR/meta', beginning agent recovery
I1217 15:57:58.734447 54864 task_status_update_manager.cpp:207] Recovering task status update manager
I1217 15:57:58.734778 54854 containerizer.cpp:727] Recovering Mesos containers
I1217 15:57:58.735138 54854 containerizer.cpp:1053] Recovering isolators
I1217 15:57:58.735801 54862 containerizer.cpp:1092] Recovering provisioner
I1217 15:57:58.736491 54847 provisioner.cpp:494] Provisioner recovery complete
I1217 15:57:58.737180 54853 composing.cpp:339] Finished recovering all containerizers
I1217 15:57:58.737319 54864 slave.cpp:7233] Recovering executors
I1217 15:57:58.737453 54864 slave.cpp:7386] Finished recovery
I1217 15:57:58.738404 54860 task_status_update_manager.cpp:181] Pausing sending task status updates
I1217 15:57:58.738425 54851 status_update_manager_process.hpp:379] Pausing operation status update manager
I1217 15:57:58.738438 54863 slave.cpp:1268] New master detected at master@172.17.0.2:36305
I1217 15:57:58.738514 54863 slave.cpp:1333] Detecting new master
I1217 15:57:58.745093 54848 slave.cpp:1360] Authenticating with master master@172.17.0.2:36305
I1217 15:57:58.745201 54848 slave.cpp:1369] Using default CRAM-MD5 authenticatee
I1217 15:57:58.745507 54854 authenticatee.cpp:121] Creating new client SASL connection
I1217 15:57:58.745837 54843 master.cpp:9691] Authenticating slave(1067)@172.17.0.2:36305
I1217 15:57:58.745970 54862 authenticator.cpp:414] Starting authentication session for crammd5-authenticatee(1859)@172.17.0.2:36305
I1217 15:57:58.746254 54844 authenticator.cpp:98] Creating new server SASL connection
I1217 15:57:58.746479 54852 authenticatee.cpp:213] Received SASL authentication mechanisms: CRAM-MD5
I1217 15:57:58.746508 54852 authenticatee.cpp:239] Attempting to authenticate with mechanism 'CRAM-MD5'
I1217 15:57:58.746645 54847 authenticator.cpp:204] Received SASL authentication start
I1217 15:57:58.746728 54847 authenticator.cpp:326] Authentication requires more steps
I1217 15:57:58.746865 54850 authenticatee.cpp:259] Received SASL authentication step
I1217 15:57:58.747021 54845 authenticator.cpp:232] Received SASL authentication step
I1217 15:57:58.747059 54845 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '85259784eebc' server FQDN: '85259784eebc' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: false
I1217 15:57:58.747077 54845 auxprop.cpp:181] Looking up auxiliary property '*userPassword'
I1217 15:57:58.747128 54845 auxprop.cpp:181] Looking up auxiliary property '*cmusaslsecretCRAM-MD5'
I1217 15:57:58.747157 54845 auxprop.cpp:109] Request to lookup properties for user: 'test-principal' realm: '85259784eebc' server FQDN: '85259784eebc' SASL_AUXPROP_VERIFY_AGAINST_HASH: false SASL_AUXPROP_OVERRIDE: false SASL_AUXPROP_AUTHZID: true
I1217 15:57:58.747172 54845 auxprop.cpp:131] Skipping auxiliary property '*userPassword' since SASL_AUXPROP_AUTHZID == true
I1217 15:57:58.747185 54845 auxprop.cpp:131] Skipping auxiliary property '*cmusaslsecretCRAM-MD5' since SASL_AUXPROP_AUTHZID == true
I1217 15:57:58.747205 54845 authenticator.cpp:318] Authentication success
I1217 15:57:58.747299 54861 authenticatee.cpp:299] Authentication success
I1217 15:57:58.747406 54859 master.cpp:9723] Successfully authenticated principal 'test-principal' at slave(1067)@172.17.0.2:36305
I1217 15:57:58.747473 54856 authenticator.cpp:432] Authentication session cleanup for crammd5-authenticatee(1859)@172.17.0.2:36305
I1217 15:57:58.747683 54866 slave.cpp:1460] Successfully authenticated with master master@172.17.0.2:36305
I1217 15:57:58.748106 54866 slave.cpp:1893] Will retry registration in 18.335681ms if necessary
I1217 15:57:58.748311 54849 master.cpp:6607] Received register agent message from slave(1067)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.748682 54849 master.cpp:3937] Authorizing agent providing resources 'cpus:2; mem:1024; disk:1024; ports:[31000-32000]' with principal 'test-principal'
I1217 15:57:58.749313 54851 master.cpp:6674] Authorized registration of agent at slave(1067)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.749420 54851 master.cpp:6789] Registering agent at slave(1067)@172.17.0.2:36305 (85259784eebc) with id d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0
I1217 15:57:58.750114 54855 registrar.cpp:487] Applied 1 operations in 233450ns; attempting to update the registry
I1217 15:57:58.750814 54855 registrar.cpp:544] Successfully updated the registry in 623872ns
I1217 15:57:58.750993 54862 master.cpp:6837] Admitted agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 at slave(1067)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.751727 54862 master.cpp:6882] Registered agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 at slave(1067)@172.17.0.2:36305 (85259784eebc) with cpus:2; mem:1024; disk:1024; ports:[31000-32000]
I1217 15:57:58.751963 54852 slave.cpp:1493] Registered with master master@172.17.0.2:36305; given agent ID d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0
I1217 15:57:58.752070 54859 task_status_update_manager.cpp:188] Resuming sending task status updates
I1217 15:57:58.752074 54847 hierarchical.cpp:603] Added agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 (85259784eebc) with cpus:2; mem:1024; disk:1024; ports:[31000-32000] (allocated: {})
I1217 15:57:58.752131 54861 status_update_manager_process.hpp:385] Resuming operation status update manager
I1217 15:57:58.752401 54847 hierarchical.cpp:1566] Performed allocation for 1 agents in 114163ns
I1217 15:57:58.752513 54852 slave.cpp:1514] Checkpointing SlaveInfo to '/tmp/ContentType_AgentResourceProviderConfigApiTest_IdempotentRemove_1_MwIcjR/meta/slaves/d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0/slave.info'
I1217 15:57:58.753682 54852 slave.cpp:1563] Forwarding agent update {"operations":{},"resource_version_uuid":{"value":"b9IGXDw7QKyHSiCjEpI9BA=="},"slave_id":{"value":"d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0"},"update_oversubscribed_resources":false}
I1217 15:57:58.754335 54863 master.cpp:7941] Ignoring update on agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 at slave(1067)@172.17.0.2:36305 (85259784eebc) as it reports no changes
I1217 15:57:58.755762 54843 process.cpp:3588] Handling HTTP event for process 'slave(1067)' with path: '/slave(1067)/api/v1'
I1217 15:57:58.756855 54859 http.cpp:1105] HTTP POST for /slave(1067)/api/v1 from 172.17.0.2:60130
I1217 15:57:58.758119 54858 http.cpp:3293] Processing REMOVE_RESOURCE_PROVIDER_CONFIG call with type 'org.apache.mesos.rp.local.storage' and name 'test'
I1217 15:57:58.759495 54856 hierarchical.cpp:1566] Performed allocation for 1 agents in 94645ns
I1217 15:57:58.759879 54850 slave.cpp:922] Agent terminating
I1217 15:57:58.810529 54858 hierarchical.cpp:1566] Performed allocation for 1 agents in 81810ns
I1217 15:57:58.861340 54847 hierarchical.cpp:1566] Performed allocation for 1 agents in 78926ns
I1217 15:57:58.913054 54860 hierarchical.cpp:1566] Performed allocation for 1 agents in 80845ns
I1217 15:57:58.963975 54851 hierarchical.cpp:1566] Performed allocation for 1 agents in 97349ns
I1217 15:57:58.984740 54857 master.cpp:1277] Agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 at slave(1067)@172.17.0.2:36305 (85259784eebc) disconnected
I1217 15:57:58.984786 54857 master.cpp:3280] Disconnecting agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 at slave(1067)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.984858 54857 master.cpp:3299] Deactivating agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 at slave(1067)@172.17.0.2:36305 (85259784eebc)
I1217 15:57:58.984988 54843 hierarchical.cpp:801] Agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0 deactivated
I1217 15:57:58.992373 54849 master.cpp:1117] Master terminating
I1217 15:57:58.993093 54843 hierarchical.cpp:643] Removed agent d7e439a6-f18a-481c-a36f-e2d4ba1ca777-S0
[ OK ] ContentType/AgentResourceProviderConfigApiTest.IdempotentRemove/1 (296 ms)
[----------] 20 tests from ContentType/AgentResourceProviderConfigApiTest (14757 ms total)
[----------] Global test environment tear-down
[==========] 2077 tests from 208 test cases ran. (1049230 ms total)
[ PASSED ] 2076 tests.
[ FAILED ] 1 test, listed below:
[ FAILED ] MasterAuthorizationTest.FrameworkRemoved
1 FAILED TEST
YOU HAVE 24 DISABLED TESTS
I1217 15:57:59.071218 54867 process.cpp:927] Stopped the socket accept loop
Makefile:14925: recipe for target 'check-local' failed
make[4]: *** [check-local] Error 1
make[4]: Leaving directory '/tmp/SRC/build/mesos-1.8.0/_build/sub/src'
Makefile:14067: recipe for target 'check-am' failed
make[3]: *** [check-am] Error 2
make[3]: Leaving directory '/tmp/SRC/build/mesos-1.8.0/_build/sub/src'
Makefile:14071: recipe for target 'check' failed
make[2]: *** [check] Error 2
make[2]: Leaving directory '/tmp/SRC/build/mesos-1.8.0/_build/sub/src'
Makefile:786: recipe for target 'check-recursive' failed
make[1]: *** [check-recursive] Error 1
make[1]: Leaving directory '/tmp/SRC/build/mesos-1.8.0/_build/sub'
Makefile:992: recipe for target 'distcheck' failed
make: *** [distcheck] Error 1
Untagged: mesos/mesos-build:ubuntu-16.04
Untagged: mesos/mesos-build@sha256:fa967cbcfb44f55708a3cbc87f245c6d29dd891464db558af56a03ee321526bb
Deleted: sha256:e895c0531b9a9a288fabe479a49f7059aed83645351ac99ec2ea2616822c9f97
Deleted: sha256:09119b0b314a69ba6ec6251f2e89f4199fe1e874c84f9abf07dcbd23dbc3f1c1
Deleted: sha256:562fe6af5a3883058be9c784a839392215ed4185a21d21f1d99df0d17f3ae6e7
Deleted: sha256:0dcdfbe322a4f332f73ac70905d557300ec6dae3bd19586758772c750c7b4a19
Deleted: sha256:c66652d605f01094e2db53d62505dbd524e076d5aa69b89d5e620003803eb149
Deleted: sha256:a2cf79bfb9593c05fd7142ddb49afef77ea4ad5d2464e841f09fe62ffee396e0
Deleted: sha256:f7a904214b390f39d98573882f631dc908df8b2b540cf04e1062f8182c1efffd
Deleted: sha256:ce1f6fcaa83dfce189d76e08f184085732eab4eeb2562d2399953958405c5bec
Deleted: sha256:cce92fda689ab9033f0b8db214bc63edd1ae3e05831a0f3a9418976d7dc7ccdd
Deleted: sha256:d22094bbd65447c59a42c580eaa3a44cee9cd855f00905f59409be21bcefc745
Deleted: sha256:b8976847450013f3eb5e9a81a5778f73ed7bef67e6393049712ef17102b4b7b7
Deleted: sha256:b8c891f0ffec910a12757d733b178e3f62d81dbbde2b31d3b754071c416108ed
Build step 'Execute shell' marked build as failure