[14:05:23.737] New invocation is queued and will start shortly
[14:05:25.171] Starting the invocation (attempt 1)
[14:05:25.269] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[14:05:25.270] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[14:05:25.270] Buildbucket request:
{
"bucket": "luci.chromium.webrtc.fyi",
"client_operation_id": "9060878488428522528",
"parameters_json": "{\"builder_name\":\"WebRTC Chromium FYI Mac Builder\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://webrtc.googlesource.com/src/\",\"revision\":\"39cf3c723e502b994e37f221155458f1bf40184d\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:WebRTC Chromium FYI Mac Builder",
"scheduler_invocation_id:9060878488428522528",
"scheduler_job_id:chromium/WebRTC Chromium FYI Mac Builder",
"user_agent:luci-scheduler",
"buildset:commit/git/39cf3c723e502b994e37f221155458f1bf40184d",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/39cf3c723e502b994e37f221155458f1bf40184d",
"gitiles_ref:refs/heads/master"
]
}
[14:05:26.639] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.webrtc.fyi",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1575036325540001",
"id": "8895448425868564192",
"parameters_json": "{\"builder_name\": \"WebRTC Chromium FYI Mac Builder\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://webrtc.googlesource.com/src/\", \"revision\": \"39cf3c723e502b994e37f221155458f1bf40184d\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1575036326405545",
"tags": [
"build_address:luci.chromium.webrtc.fyi/WebRTC Chromium FYI Mac Builder/4843",
"builder:WebRTC Chromium FYI Mac Builder",
"buildset:commit/git/39cf3c723e502b994e37f221155458f1bf40184d",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/39cf3c723e502b994e37f221155458f1bf40184d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9060878488428522528",
"scheduler_job_id:chromium/WebRTC Chromium FYI Mac Builder",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8895448425868564192/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1575036326405882",
"url": "https://ci.chromium.org/b/8895448425868564192",
"utcnow_ts": "1575036326627657"
}
}
[14:05:26.639] Task URL: https://ci.chromium.org/b/8895448425868564192
[14:05:26.639] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:2:0) after 1m0s
[14:05:42.915] Received PubSub notification, asking Buildbucket for the build status
[14:05:42.999] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:26.679] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:2:0)
[14:06:26.679] Timer tick, asking Buildbucket for the build status
[14:06:26.782] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:06:26.782] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:4:0) after 1m0s
[14:07:26.761] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:4:0)
[14:07:26.761] Timer tick, asking Buildbucket for the build status
[14:07:26.990] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:07:26.990] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:5:0) after 1m0s
[14:08:27.013] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:5:0)
[14:08:27.013] Timer tick, asking Buildbucket for the build status
[14:08:27.274] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:08:27.274] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:6:0) after 1m0s
[14:09:27.336] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:6:0)
[14:09:27.336] Timer tick, asking Buildbucket for the build status
[14:09:27.472] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:09:27.472] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:7:0) after 1m0s
[14:10:27.529] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:7:0)
[14:10:27.529] Timer tick, asking Buildbucket for the build status
[14:10:27.991] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:27.992] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:8:0) after 1m0s
[14:11:28.030] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:8:0)
[14:11:28.030] Timer tick, asking Buildbucket for the build status
[14:11:28.293] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:28.293] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:9:0) after 1m0s
[14:12:28.372] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:9:0)
[14:12:28.372] Timer tick, asking Buildbucket for the build status
[14:12:28.684] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:28.684] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:10:0) after 1m0s
[14:13:28.772] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:10:0)
[14:13:28.772] Timer tick, asking Buildbucket for the build status
[14:13:29.108] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:29.108] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:11:0) after 1m0s
[14:14:29.193] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:11:0)
[14:14:29.193] Timer tick, asking Buildbucket for the build status
[14:14:30.671] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:30.671] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:12:0) after 1m0s
[14:15:30.708] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:12:0)
[14:15:30.708] Timer tick, asking Buildbucket for the build status
[14:15:30.848] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:30.848] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:13:0) after 1m0s
[14:16:30.873] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:13:0)
[14:16:30.873] Timer tick, asking Buildbucket for the build status
[14:16:31.209] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:31.209] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:14:0) after 1m0s
[14:17:31.281] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:14:0)
[14:17:31.281] Timer tick, asking Buildbucket for the build status
[14:17:31.526] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:31.526] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:15:0) after 1m0s
[14:18:31.569] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:15:0)
[14:18:31.569] Timer tick, asking Buildbucket for the build status
[14:18:31.722] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:31.722] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:16:0) after 1m0s
[14:19:31.786] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:16:0)
[14:19:31.786] Timer tick, asking Buildbucket for the build status
[14:19:32.361] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:32.361] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:17:0) after 1m0s
[14:20:32.383] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:17:0)
[14:20:32.383] Timer tick, asking Buildbucket for the build status
[14:20:32.478] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:32.478] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:18:0) after 1m0s
[14:21:32.542] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:18:0)
[14:21:32.542] Timer tick, asking Buildbucket for the build status
[14:21:32.685] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:32.686] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:19:0) after 1m0s
[14:22:32.701] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:19:0)
[14:22:32.701] Timer tick, asking Buildbucket for the build status
[14:22:32.830] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:32.830] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:20:0) after 1m0s
[14:23:32.833] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:20:0)
[14:23:32.833] Timer tick, asking Buildbucket for the build status
[14:23:32.965] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:32.965] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:21:0) after 1m0s
[14:24:33.031] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:21:0)
[14:24:33.032] Timer tick, asking Buildbucket for the build status
[14:24:33.253] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:33.253] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:22:0) after 1m0s
[14:25:33.333] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:22:0)
[14:25:33.333] Timer tick, asking Buildbucket for the build status
[14:25:33.443] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:33.443] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:23:0) after 1m0s
[14:26:33.509] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:23:0)
[14:26:33.509] Timer tick, asking Buildbucket for the build status
[14:26:33.613] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:33.613] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:24:0) after 1m0s
[14:27:33.670] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:24:0)
[14:27:33.670] Timer tick, asking Buildbucket for the build status
[14:27:33.889] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:33.889] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:25:0) after 1m0s
[14:28:33.921] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:25:0)
[14:28:33.921] Timer tick, asking Buildbucket for the build status
[14:28:34.087] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:34.088] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:26:0) after 1m0s
[14:29:34.097] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:26:0)
[14:29:34.097] Timer tick, asking Buildbucket for the build status
[14:29:36.139] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:36.139] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:27:0) after 1m0s
[14:30:36.262] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:27:0)
[14:30:36.262] Timer tick, asking Buildbucket for the build status
[14:30:36.509] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:36.509] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:28:0) after 1m0s
[14:31:36.557] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:28:0)
[14:31:36.557] Timer tick, asking Buildbucket for the build status
[14:31:36.755] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:36.755] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:29:0) after 1m0s
[14:32:36.790] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:29:0)
[14:32:36.790] Timer tick, asking Buildbucket for the build status
[14:32:36.985] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:36.985] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:30:0) after 1m0s
[14:33:37.057] Handling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:30:0)
[14:33:37.057] Timer tick, asking Buildbucket for the build status
[14:33:37.150] Build 8895448425868564192: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:37.150] Scheduling timer "check-buildbucket-build-status" (chromium/WebRTC Chromium FYI Mac Builder:9060878488428522528:31:0) after 1m0s
[14:33:55.703] Received PubSub notification, asking Buildbucket for the build status
[14:33:55.910] Build 8895448425868564192: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[14:33:55.910] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.webrtc.fyi",
"canary_preference": "PROD",
"completed_ts": "1575038034808898",
"created_by": "project:chromium",
"created_ts": "1575036325540001",
"id": "8895448425868564192",
"parameters_json": "{\"builder_name\": \"WebRTC Chromium FYI Mac Builder\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://webrtc.googlesource.com/src/\", \"revision\": \"39cf3c723e502b994e37f221155458f1bf40184d\"}}",
"project": "chromium",
"result": "SUCCESS",
"result_details_json": "{\"properties\": {\"$build/goma\": {\"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"vm326-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"WebRTC Chromium FYI Mac Builder\", \"buildnumber\": 4843, \"got_angle_revision\": \"bc82fb14aab4b1238cdb7291bdd34816863f26b8\", \"got_clang_revision\": \"n331734-e84b7a5f-1\", \"got_cr_revision\": \"8dd52f5be15383ebdbb71fa34e40be5e5aced397\", \"got_cr_revision_cp\": \"refs/heads/master@{#720183}\", \"got_dawn_revision\": \"77f6db7a0b7856376553b470dbe3940a4fbbc30c\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"39cf3c723e502b994e37f221155458f1bf40184d\", \"got_revision_cp\": \"refs/heads/master@{#29961}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_swiftshader_revision\": \"fb7ca1d5aca5c885520a6ddae7806de9f28ad8ec\", \"got_v8_revision\": \"0a58befec161d3c68ef7206e96a863c6caf1ed6d\", \"got_v8_revision_cp\": \"refs/heads/8.0.416@{#1}\", \"got_webrtc_revision\": \"39cf3c723e502b994e37f221155458f1bf40184d\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#29961}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mastername\": \"chromium.webrtc.fyi\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://webrtc.googlesource.com/src/\", \"revision\": \"39cf3c723e502b994e37f221155458f1bf40184d\", \"swarm_hashes_refs/heads/master(at){#29961}_without_patch\": {\"browser_tests\": \"c9c72f2b7aebc6b5f47343d0457b7c30e2b11e43\", \"browser_tests_apprtc\": \"091ae868c5367427fce15e585dce1d63633c839e\", \"content_browsertests\": \"6e04dd180f955e9475fff2b37073dabc036dba61\", \"content_unittests\": \"37ba308e2bc3672d04f80a1e5566d4b69e50c521\", \"jingle_unittests\": \"df858e1e6c0963a3208c65085fd0dabe049393ce\", \"remoting_unittests\": \"af7e930dafe6c52e44b74f6676afc0d3f8f296db\"}, \"xcode_build_version\": \"10e1001\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"builder_4d315a21d49582f6ac1269241de18b93ec0f808a2ae7b2201a57612ac5fb468f_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-E5-2697_v2\"], \"gce\": [\"0\"], \"gpu\": [\"none\"], \"id\": [\"vm326-m9\"], \"mac_model\": [\"VMware7,1\"], \"machine_type\": [\"n1-highcpu-8\"], \"os\": [\"Mac\", \"Mac-10.14\", \"Mac-10.14.4\"], \"pool\": [\"luci.chromium.webrtc.fyi\"], \"python\": [\"2.7.10\"], \"server_version\": [\"4662-e230705\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1575036341317275",
"status": "COMPLETED",
"status_changed_ts": "1575038035320401",
"tags": [
"build_address:luci.chromium.webrtc.fyi/WebRTC Chromium FYI Mac Builder/4843",
"builder:WebRTC Chromium FYI Mac Builder",
"buildset:commit/git/39cf3c723e502b994e37f221155458f1bf40184d",
"buildset:commit/gitiles/webrtc.googlesource.com/src/+/39cf3c723e502b994e37f221155458f1bf40184d",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9060878488428522528",
"scheduler_job_id:chromium/WebRTC Chromium FYI Mac Builder",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8895448425868564192/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Mac",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:48d04c9de68d4110",
"user_agent:luci-scheduler"
],
"updated_ts": "1575038035347630",
"url": "https://ci.chromium.org/b/8895448425868564192",
"utcnow_ts": "1575038035896035"
}
}
[14:33:55.910] Invocation finished in 28m32.194732085s with status SUCCEEDED