[14:05:54.458] New invocation is queued and will start shortly
[14:05:55.955] Starting the invocation (attempt 1)
[14:05:56.002] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[14:05:56.002] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[14:05:56.002] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9040584735738632976",
"parameters_json": "{\"builder_name\":\"ToTiOS\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"8734154bae4101e4911b8c9178d432286c636c20\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:ToTiOS",
"scheduler_invocation_id:9040584735738632976",
"scheduler_job_id:chromium/ToTiOS",
"user_agent:luci-scheduler",
"buildset:commit/git/8734154bae4101e4911b8c9178d432286c636c20",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/8734154bae4101e4911b8c9178d432286c636c20",
"gitiles_ref:refs/heads/master"
]
}
[14:06:00.400] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1594389956283861",
"id": "8875154673159095408",
"parameters_json": "{\"builder_name\": \"ToTiOS\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"8734154bae4101e4911b8c9178d432286c636c20\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1594389959880306",
"tags": [
"build_address:luci.chromium.ci/ToTiOS/14970",
"builder:ToTiOS",
"buildset:commit/git/8734154bae4101e4911b8c9178d432286c636c20",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/8734154bae4101e4911b8c9178d432286c636c20",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9040584735738632976",
"scheduler_job_id:chromium/ToTiOS",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8875154673159095408/+/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": "1594389959898715",
"url": "https://ci.chromium.org/b/8875154673159095408",
"utcnow_ts": "1594389960366242"
}
}
[14:06:00.400] Task URL: https://ci.chromium.org/b/8875154673159095408
[14:06:00.400] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:2:0) after 1m0s
[14:07:00.722] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:2:0)
[14:07:00.722] Timer tick, asking Buildbucket for the build status
[14:07:00.953] Build 8875154673159095408: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:07:00.953] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:3:0) after 1m0s
[14:08:01.091] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:3:0)
[14:08:01.091] Timer tick, asking Buildbucket for the build status
[14:08:01.210] Build 8875154673159095408: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:08:01.210] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:4:0) after 1m0s
[14:09:01.865] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:4:0)
[14:09:01.865] Timer tick, asking Buildbucket for the build status
[14:09:02.041] Build 8875154673159095408: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[14:09:02.041] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:5:0) after 1m0s
[14:09:57.275] Received PubSub notification, asking Buildbucket for the build status
[14:09:57.518] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:02.095] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:5:0)
[14:10:02.095] Timer tick, asking Buildbucket for the build status
[14:10:02.317] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:10:02.317] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:7:0) after 1m0s
[14:11:02.401] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:7:0)
[14:11:02.401] Timer tick, asking Buildbucket for the build status
[14:11:02.915] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:11:02.915] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:8:0) after 1m0s
[14:12:03.006] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:8:0)
[14:12:03.006] Timer tick, asking Buildbucket for the build status
[14:12:03.842] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:12:03.842] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:9:0) after 1m0s
[14:13:03.836] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:9:0)
[14:13:03.837] Timer tick, asking Buildbucket for the build status
[14:13:03.960] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:13:03.960] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:10:0) after 1m0s
[14:14:04.043] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:10:0)
[14:14:04.043] Timer tick, asking Buildbucket for the build status
[14:14:04.191] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:14:04.191] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:11:0) after 1m0s
[14:15:04.236] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:11:0)
[14:15:04.236] Timer tick, asking Buildbucket for the build status
[14:15:04.372] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:15:04.372] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:12:0) after 1m0s
[14:16:04.405] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:12:0)
[14:16:04.405] Timer tick, asking Buildbucket for the build status
[14:16:04.659] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:16:04.659] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:13:0) after 1m0s
[14:17:04.721] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:13:0)
[14:17:04.721] Timer tick, asking Buildbucket for the build status
[14:17:05.159] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:17:05.159] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:14:0) after 1m0s
[14:18:05.188] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:14:0)
[14:18:05.189] Timer tick, asking Buildbucket for the build status
[14:18:11.170] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:18:11.170] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:15:0) after 1m0s
[14:19:11.215] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:15:0)
[14:19:11.215] Timer tick, asking Buildbucket for the build status
[14:19:11.401] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:19:11.401] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:16:0) after 1m0s
[14:20:11.431] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:16:0)
[14:20:11.431] Timer tick, asking Buildbucket for the build status
[14:20:11.612] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:20:11.612] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:17:0) after 1m0s
[14:21:11.651] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:17:0)
[14:21:11.651] Timer tick, asking Buildbucket for the build status
[14:21:11.782] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:21:11.782] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:18:0) after 1m0s
[14:22:11.864] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:18:0)
[14:22:11.864] Timer tick, asking Buildbucket for the build status
[14:22:12.201] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:22:12.201] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:19:0) after 1m0s
[14:23:12.271] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:19:0)
[14:23:12.271] Timer tick, asking Buildbucket for the build status
[14:23:17.768] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:23:17.768] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:20:0) after 1m0s
[14:24:17.838] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:20:0)
[14:24:17.838] Timer tick, asking Buildbucket for the build status
[14:24:17.990] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:24:17.990] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:21:0) after 1m0s
[14:25:18.089] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:21:0)
[14:25:18.089] Timer tick, asking Buildbucket for the build status
[14:25:18.242] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:25:18.242] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:22:0) after 1m0s
[14:26:18.438] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:22:0)
[14:26:18.438] Timer tick, asking Buildbucket for the build status
[14:26:18.824] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:26:18.824] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:23:0) after 1m0s
[14:27:18.915] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:23:0)
[14:27:18.915] Timer tick, asking Buildbucket for the build status
[14:27:19.790] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:27:19.790] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:24:0) after 1m0s
[14:28:19.875] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:24:0)
[14:28:19.875] Timer tick, asking Buildbucket for the build status
[14:28:20.322] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:28:20.322] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:25:0) after 1m0s
[14:29:20.303] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:25:0)
[14:29:20.303] Timer tick, asking Buildbucket for the build status
[14:29:20.460] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:29:20.460] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:26:0) after 1m0s
[14:30:20.457] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:26:0)
[14:30:20.457] Timer tick, asking Buildbucket for the build status
[14:30:20.937] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:30:20.937] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:27:0) after 1m0s
[14:31:20.997] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:27:0)
[14:31:20.997] Timer tick, asking Buildbucket for the build status
[14:31:21.501] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:31:21.501] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:28:0) after 1m0s
[14:32:21.517] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:28:0)
[14:32:21.517] Timer tick, asking Buildbucket for the build status
[14:32:22.540] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:32:22.540] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:29:0) after 1m0s
[14:33:22.523] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:29:0)
[14:33:22.523] Timer tick, asking Buildbucket for the build status
[14:33:23.252] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:33:23.252] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:30:0) after 1m0s
[14:34:23.297] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:30:0)
[14:34:23.297] Timer tick, asking Buildbucket for the build status
[14:34:23.987] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:34:23.987] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:31:0) after 1m0s
[14:35:24.172] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:31:0)
[14:35:24.173] Timer tick, asking Buildbucket for the build status
[14:35:26.042] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:35:26.042] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:32:0) after 1m0s
[14:36:26.079] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:32:0)
[14:36:26.079] Timer tick, asking Buildbucket for the build status
[14:36:29.541] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:36:29.541] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:33:0) after 1m0s
[14:37:29.569] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:33:0)
[14:37:29.569] Timer tick, asking Buildbucket for the build status
[14:37:29.812] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:37:29.812] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:34:0) after 1m0s
[14:38:29.883] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:34:0)
[14:38:29.883] Timer tick, asking Buildbucket for the build status
[14:38:30.032] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:38:30.032] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:35:0) after 1m0s
[14:39:30.062] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:35:0)
[14:39:30.062] Timer tick, asking Buildbucket for the build status
[14:39:30.202] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:39:30.202] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:36:0) after 1m0s
[14:40:30.278] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:36:0)
[14:40:30.278] Timer tick, asking Buildbucket for the build status
[14:40:30.396] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:40:30.396] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:37:0) after 1m0s
[14:41:30.410] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:37:0)
[14:41:30.410] Timer tick, asking Buildbucket for the build status
[14:41:30.933] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:41:30.933] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:38:0) after 1m0s
[14:42:31.415] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:38:0)
[14:42:31.415] Timer tick, asking Buildbucket for the build status
[14:42:33.265] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:42:33.265] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:39:0) after 1m0s
[14:43:33.359] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:39:0)
[14:43:33.359] Timer tick, asking Buildbucket for the build status
[14:43:33.844] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:43:33.844] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:40:0) after 1m0s
[14:44:33.892] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:40:0)
[14:44:33.892] Timer tick, asking Buildbucket for the build status
[14:44:34.027] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:44:34.027] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:41:0) after 1m0s
[14:45:34.207] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:41:0)
[14:45:34.207] Timer tick, asking Buildbucket for the build status
[14:45:34.525] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:45:34.525] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:42:0) after 1m0s
[14:46:34.602] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:42:0)
[14:46:34.602] Timer tick, asking Buildbucket for the build status
[14:46:35.573] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:46:35.573] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:43:0) after 1m0s
[14:47:35.695] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:43:0)
[14:47:35.695] Timer tick, asking Buildbucket for the build status
[14:47:35.833] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:35.833] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:44:0) after 1m0s
[14:48:35.824] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:44:0)
[14:48:35.825] Timer tick, asking Buildbucket for the build status
[14:48:35.938] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:35.938] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:45:0) after 1m0s
[14:49:35.988] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:45:0)
[14:49:35.988] Timer tick, asking Buildbucket for the build status
[14:49:36.182] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:36.182] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:46:0) after 1m0s
[14:50:36.211] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:46:0)
[14:50:36.211] Timer tick, asking Buildbucket for the build status
[14:50:36.678] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:36.678] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:47:0) after 1m0s
[14:51:36.701] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:47:0)
[14:51:36.701] Timer tick, asking Buildbucket for the build status
[14:51:37.599] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:37.599] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:48:0) after 1m0s
[14:52:37.673] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:48:0)
[14:52:37.673] Timer tick, asking Buildbucket for the build status
[14:52:38.143] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:38.143] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:49:0) after 1m0s
[14:53:38.178] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:49:0)
[14:53:38.178] Timer tick, asking Buildbucket for the build status
[14:53:38.674] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:38.674] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:50:0) after 1m0s
[14:54:38.702] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:50:0)
[14:54:38.702] Timer tick, asking Buildbucket for the build status
[14:54:38.928] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:38.928] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:51:0) after 1m0s
[14:55:39.028] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:51:0)
[14:55:39.028] Timer tick, asking Buildbucket for the build status
[14:55:39.271] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:39.271] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:52:0) after 1m0s
[14:56:39.293] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:52:0)
[14:56:39.294] Timer tick, asking Buildbucket for the build status
[14:56:39.999] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:39.999] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:53:0) after 1m0s
[14:57:40.113] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:53:0)
[14:57:40.113] Timer tick, asking Buildbucket for the build status
[14:57:40.257] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:40.257] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:54:0) after 1m0s
[14:58:40.316] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:54:0)
[14:58:40.316] Timer tick, asking Buildbucket for the build status
[14:58:40.475] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:40.475] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:55:0) after 1m0s
[14:59:40.587] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:55:0)
[14:59:40.587] Timer tick, asking Buildbucket for the build status
[14:59:40.740] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:40.740] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:56:0) after 1m0s
[15:00:40.861] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:56:0)
[15:00:40.861] Timer tick, asking Buildbucket for the build status
[15:00:41.338] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:41.338] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:57:0) after 1m0s
[15:01:41.384] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:57:0)
[15:01:41.384] Timer tick, asking Buildbucket for the build status
[15:01:42.028] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:42.028] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:58:0) after 1m0s
[15:02:42.060] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:58:0)
[15:02:42.060] Timer tick, asking Buildbucket for the build status
[15:02:43.573] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:43.573] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:59:0) after 1m0s
[15:03:43.822] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:59:0)
[15:03:43.822] Timer tick, asking Buildbucket for the build status
[15:03:44.724] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:44.724] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:60:0) after 1m0s
[15:04:44.870] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:60:0)
[15:04:44.870] Timer tick, asking Buildbucket for the build status
[15:04:45.048] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:45.048] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:61:0) after 1m0s
[15:05:45.154] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:61:0)
[15:05:45.154] Timer tick, asking Buildbucket for the build status
[15:05:45.342] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:45.342] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:62:0) after 1m0s
[15:06:45.470] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:62:0)
[15:06:45.470] Timer tick, asking Buildbucket for the build status
[15:06:45.600] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:45.600] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:63:0) after 1m0s
[15:07:45.723] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:63:0)
[15:07:45.724] Timer tick, asking Buildbucket for the build status
[15:07:46.125] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:46.125] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:64:0) after 1m0s
[15:08:46.225] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:64:0)
[15:08:46.225] Timer tick, asking Buildbucket for the build status
[15:08:46.367] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:46.367] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:65:0) after 1m0s
[15:09:46.391] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:65:0)
[15:09:46.391] Timer tick, asking Buildbucket for the build status
[15:09:46.780] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:09:46.780] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:66:0) after 1m0s
[15:10:46.866] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:66:0)
[15:10:46.866] Timer tick, asking Buildbucket for the build status
[15:10:47.801] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:10:47.801] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:67:0) after 1m0s
[15:11:47.824] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:67:0)
[15:11:47.824] Timer tick, asking Buildbucket for the build status
[15:11:48.025] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:11:48.025] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:68:0) after 1m0s
[15:12:48.104] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:68:0)
[15:12:48.104] Timer tick, asking Buildbucket for the build status
[15:12:48.305] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:12:48.305] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:69:0) after 1m0s
[15:13:48.382] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:69:0)
[15:13:48.382] Timer tick, asking Buildbucket for the build status
[15:13:48.702] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:13:48.702] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:70:0) after 1m0s
[15:14:48.836] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:70:0)
[15:14:48.836] Timer tick, asking Buildbucket for the build status
[15:14:49.211] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:14:49.211] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:71:0) after 1m0s
[15:15:49.305] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:71:0)
[15:15:49.305] Timer tick, asking Buildbucket for the build status
[15:15:49.495] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:15:49.495] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:72:0) after 1m0s
[15:16:49.506] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:72:0)
[15:16:49.506] Timer tick, asking Buildbucket for the build status
[15:16:51.019] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:16:51.019] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:73:0) after 1m0s
[15:17:51.078] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:73:0)
[15:17:51.078] Timer tick, asking Buildbucket for the build status
[15:17:51.181] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:17:51.181] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:74:0) after 1m0s
[15:18:51.240] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:74:0)
[15:18:51.240] Timer tick, asking Buildbucket for the build status
[15:18:51.381] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:18:51.381] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:75:0) after 1m0s
[15:19:51.380] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:75:0)
[15:19:51.380] Timer tick, asking Buildbucket for the build status
[15:19:51.648] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:19:51.648] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:76:0) after 1m0s
[15:20:51.670] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:76:0)
[15:20:51.670] Timer tick, asking Buildbucket for the build status
[15:20:51.863] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:20:51.863] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:77:0) after 1m0s
[15:21:51.952] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:77:0)
[15:21:51.952] Timer tick, asking Buildbucket for the build status
[15:21:52.195] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:21:52.195] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:78:0) after 1m0s
[15:22:52.410] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:78:0)
[15:22:52.410] Timer tick, asking Buildbucket for the build status
[15:22:52.633] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:22:52.633] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:79:0) after 1m0s
[15:23:52.694] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:79:0)
[15:23:52.694] Timer tick, asking Buildbucket for the build status
[15:23:52.802] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:23:52.802] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:80:0) after 1m0s
[15:24:52.956] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:80:0)
[15:24:52.956] Timer tick, asking Buildbucket for the build status
[15:24:53.089] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:24:53.089] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:81:0) after 1m0s
[15:25:53.206] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:81:0)
[15:25:53.206] Timer tick, asking Buildbucket for the build status
[15:25:53.370] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:25:53.370] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:82:0) after 1m0s
[15:26:53.424] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:82:0)
[15:26:53.424] Timer tick, asking Buildbucket for the build status
[15:26:59.725] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:26:59.725] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:83:0) after 1m0s
[15:27:59.783] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:83:0)
[15:27:59.783] Timer tick, asking Buildbucket for the build status
[15:27:59.940] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:27:59.940] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:84:0) after 1m0s
[15:28:59.952] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:84:0)
[15:28:59.952] Timer tick, asking Buildbucket for the build status
[15:29:00.199] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:29:00.199] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:85:0) after 1m0s
[15:30:00.213] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:85:0)
[15:30:00.213] Timer tick, asking Buildbucket for the build status
[15:30:00.744] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:30:00.744] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:86:0) after 1m0s
[15:31:01.903] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:86:0)
[15:31:01.903] Timer tick, asking Buildbucket for the build status
[15:31:02.141] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:31:02.141] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:87:0) after 1m0s
[15:32:02.192] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:87:0)
[15:32:02.192] Timer tick, asking Buildbucket for the build status
[15:32:02.433] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:32:02.433] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:88:0) after 1m0s
[15:33:02.423] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:88:0)
[15:33:02.423] Timer tick, asking Buildbucket for the build status
[15:33:02.758] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:33:02.758] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:89:0) after 1m0s
[15:34:02.796] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:89:0)
[15:34:02.796] Timer tick, asking Buildbucket for the build status
[15:34:03.349] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:34:03.349] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:90:0) after 1m0s
[15:35:03.432] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:90:0)
[15:35:03.432] Timer tick, asking Buildbucket for the build status
[15:35:03.637] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:35:03.637] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:91:0) after 1m0s
[15:36:03.691] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:91:0)
[15:36:03.691] Timer tick, asking Buildbucket for the build status
[15:36:04.188] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:36:04.188] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:92:0) after 1m0s
[15:37:04.282] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:92:0)
[15:37:04.282] Timer tick, asking Buildbucket for the build status
[15:37:04.628] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:37:04.628] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:93:0) after 1m0s
[15:38:04.678] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:93:0)
[15:38:04.678] Timer tick, asking Buildbucket for the build status
[15:38:04.843] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:38:04.843] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:94:0) after 1m0s
[15:39:04.918] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:94:0)
[15:39:04.918] Timer tick, asking Buildbucket for the build status
[15:39:05.117] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:39:05.117] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:95:0) after 1m0s
[15:40:05.168] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:95:0)
[15:40:05.168] Timer tick, asking Buildbucket for the build status
[15:40:05.417] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:40:05.417] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:96:0) after 1m0s
[15:41:05.493] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:96:0)
[15:41:05.493] Timer tick, asking Buildbucket for the build status
[15:41:05.669] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:41:05.669] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:97:0) after 1m0s
[15:42:05.807] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:97:0)
[15:42:05.807] Timer tick, asking Buildbucket for the build status
[15:42:06.259] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:42:06.259] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:98:0) after 1m0s
[15:43:06.272] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:98:0)
[15:43:06.272] Timer tick, asking Buildbucket for the build status
[15:43:06.387] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:43:06.387] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:99:0) after 1m0s
[15:44:06.415] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:99:0)
[15:44:06.415] Timer tick, asking Buildbucket for the build status
[15:44:06.542] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:44:06.542] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:100:0) after 1m0s
[15:45:06.575] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:100:0)
[15:45:06.575] Timer tick, asking Buildbucket for the build status
[15:45:06.848] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:45:06.848] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:101:0) after 1m0s
[15:46:06.946] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:101:0)
[15:46:06.946] Timer tick, asking Buildbucket for the build status
[15:46:07.089] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:46:07.089] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:102:0) after 1m0s
[15:47:07.163] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:102:0)
[15:47:07.163] Timer tick, asking Buildbucket for the build status
[15:47:07.426] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:47:07.426] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:103:0) after 1m0s
[15:48:07.479] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:103:0)
[15:48:07.479] Timer tick, asking Buildbucket for the build status
[15:48:07.722] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:48:07.722] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:104:0) after 1m0s
[15:49:07.863] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:104:0)
[15:49:07.863] Timer tick, asking Buildbucket for the build status
[15:49:08.406] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:49:08.406] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:105:0) after 1m0s
[15:50:08.685] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:105:0)
[15:50:08.685] Timer tick, asking Buildbucket for the build status
[15:50:09.619] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:50:09.619] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:106:0) after 1m0s
[15:51:09.714] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:106:0)
[15:51:09.714] Timer tick, asking Buildbucket for the build status
[15:51:09.871] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:51:09.871] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:107:0) after 1m0s
[15:52:09.914] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:107:0)
[15:52:09.914] Timer tick, asking Buildbucket for the build status
[15:52:10.077] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:52:10.078] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:108:0) after 1m0s
[15:53:10.146] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:108:0)
[15:53:10.146] Timer tick, asking Buildbucket for the build status
[15:53:10.281] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:53:10.281] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:109:0) after 1m0s
[15:54:10.327] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:109:0)
[15:54:10.327] Timer tick, asking Buildbucket for the build status
[15:54:11.603] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:54:11.603] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:110:0) after 1m0s
[15:55:11.717] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:110:0)
[15:55:11.717] Timer tick, asking Buildbucket for the build status
[15:55:11.870] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:55:11.870] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:111:0) after 1m0s
[15:56:11.962] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:111:0)
[15:56:11.962] Timer tick, asking Buildbucket for the build status
[15:56:13.256] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:56:13.256] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:112:0) after 1m0s
[15:57:13.340] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:112:0)
[15:57:13.340] Timer tick, asking Buildbucket for the build status
[15:57:13.486] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:57:13.486] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:113:0) after 1m0s
[15:58:13.576] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:113:0)
[15:58:13.576] Timer tick, asking Buildbucket for the build status
[15:58:14.093] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:58:14.093] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:114:0) after 1m0s
[15:59:14.158] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:114:0)
[15:59:14.158] Timer tick, asking Buildbucket for the build status
[15:59:14.745] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:59:14.745] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:115:0) after 1m0s
[16:00:14.784] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:115:0)
[16:00:14.784] Timer tick, asking Buildbucket for the build status
[16:00:15.003] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:00:15.003] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:116:0) after 1m0s
[16:01:15.064] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:116:0)
[16:01:15.064] Timer tick, asking Buildbucket for the build status
[16:01:15.553] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:01:15.553] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:117:0) after 1m0s
[16:02:15.604] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:117:0)
[16:02:15.604] Timer tick, asking Buildbucket for the build status
[16:02:16.252] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:02:16.252] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:118:0) after 1m0s
[16:03:16.300] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:118:0)
[16:03:16.300] Timer tick, asking Buildbucket for the build status
[16:03:16.488] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:03:16.488] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:119:0) after 1m0s
[16:04:16.548] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:119:0)
[16:04:16.548] Timer tick, asking Buildbucket for the build status
[16:04:16.681] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:04:16.681] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:120:0) after 1m0s
[16:05:16.735] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:120:0)
[16:05:16.735] Timer tick, asking Buildbucket for the build status
[16:05:17.589] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:05:17.589] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:121:0) after 1m0s
[16:06:17.659] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:121:0)
[16:06:17.659] Timer tick, asking Buildbucket for the build status
[16:06:17.789] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:06:17.789] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:122:0) after 1m0s
[16:07:17.857] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:122:0)
[16:07:17.857] Timer tick, asking Buildbucket for the build status
[16:07:18.025] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:07:18.025] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:123:0) after 1m0s
[16:08:18.027] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:123:0)
[16:08:18.027] Timer tick, asking Buildbucket for the build status
[16:08:18.534] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:08:18.534] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:124:0) after 1m0s
[16:09:18.612] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:124:0)
[16:09:18.612] Timer tick, asking Buildbucket for the build status
[16:09:18.758] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:09:18.758] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:125:0) after 1m0s
[16:10:18.795] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:125:0)
[16:10:18.795] Timer tick, asking Buildbucket for the build status
[16:10:18.930] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:10:18.930] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:126:0) after 1m0s
[16:11:18.990] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:126:0)
[16:11:18.990] Timer tick, asking Buildbucket for the build status
[16:11:19.143] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:11:19.143] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:127:0) after 1m0s
[16:12:19.267] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:127:0)
[16:12:19.267] Timer tick, asking Buildbucket for the build status
[16:12:19.402] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:12:19.402] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:128:0) after 1m0s
[16:13:19.487] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:128:0)
[16:13:19.487] Timer tick, asking Buildbucket for the build status
[16:13:19.682] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:13:19.682] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:129:0) after 1m0s
[16:14:19.719] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:129:0)
[16:14:19.719] Timer tick, asking Buildbucket for the build status
[16:14:19.901] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:14:19.901] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:130:0) after 1m0s
[16:15:20.042] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:130:0)
[16:15:20.042] Timer tick, asking Buildbucket for the build status
[16:15:20.245] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:15:20.245] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:131:0) after 1m0s
[16:16:20.314] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:131:0)
[16:16:20.315] Timer tick, asking Buildbucket for the build status
[16:16:20.443] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:16:20.443] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:132:0) after 1m0s
[16:17:20.502] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:132:0)
[16:17:20.502] Timer tick, asking Buildbucket for the build status
[16:17:20.748] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:17:20.748] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:133:0) after 1m0s
[16:18:20.775] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:133:0)
[16:18:20.775] Timer tick, asking Buildbucket for the build status
[16:18:21.147] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:18:21.147] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:134:0) after 1m0s
[16:19:21.932] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:134:0)
[16:19:21.933] Timer tick, asking Buildbucket for the build status
[16:19:22.076] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:19:22.076] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:135:0) after 1m0s
[16:20:22.616] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:135:0)
[16:20:22.616] Timer tick, asking Buildbucket for the build status
[16:20:22.783] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:20:22.783] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:136:0) after 1m0s
[16:21:22.947] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:136:0)
[16:21:22.947] Timer tick, asking Buildbucket for the build status
[16:21:23.481] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:21:23.481] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:137:0) after 1m0s
[16:22:23.663] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:137:0)
[16:22:23.663] Timer tick, asking Buildbucket for the build status
[16:22:23.809] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:22:23.809] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:138:0) after 1m0s
[16:23:24.092] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:138:0)
[16:23:24.092] Timer tick, asking Buildbucket for the build status
[16:23:24.742] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:23:24.742] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:139:0) after 1m0s
[16:24:25.210] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:139:0)
[16:24:25.210] Timer tick, asking Buildbucket for the build status
[16:24:25.434] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:24:25.434] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:140:0) after 1m0s
[16:25:25.689] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:140:0)
[16:25:25.689] Timer tick, asking Buildbucket for the build status
[16:25:25.859] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:25:25.859] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:141:0) after 1m0s
[16:26:26.623] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:141:0)
[16:26:26.623] Timer tick, asking Buildbucket for the build status
[16:26:26.760] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:26:26.760] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:142:0) after 1m0s
[16:27:27.171] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:142:0)
[16:27:27.171] Timer tick, asking Buildbucket for the build status
[16:27:27.415] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:27:27.415] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:143:0) after 1m0s
[16:28:27.843] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:143:0)
[16:28:27.843] Timer tick, asking Buildbucket for the build status
[16:28:28.010] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:28:28.010] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:144:0) after 1m0s
[16:29:28.363] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:144:0)
[16:29:28.363] Timer tick, asking Buildbucket for the build status
[16:29:28.645] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:29:28.645] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:145:0) after 1m0s
[16:30:28.953] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:145:0)
[16:30:28.953] Timer tick, asking Buildbucket for the build status
[16:30:29.327] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:30:29.327] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:146:0) after 1m0s
[16:31:29.343] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:146:0)
[16:31:29.343] Timer tick, asking Buildbucket for the build status
[16:31:29.535] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:31:29.535] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:147:0) after 1m0s
[16:32:29.723] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:147:0)
[16:32:29.723] Timer tick, asking Buildbucket for the build status
[16:32:29.839] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:32:29.839] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:148:0) after 1m0s
[16:33:29.885] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:148:0)
[16:33:29.885] Timer tick, asking Buildbucket for the build status
[16:33:30.022] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:33:30.022] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:149:0) after 1m0s
[16:34:30.082] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:149:0)
[16:34:30.082] Timer tick, asking Buildbucket for the build status
[16:34:30.242] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:34:30.243] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:150:0) after 1m0s
[16:35:30.535] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:150:0)
[16:35:30.535] Timer tick, asking Buildbucket for the build status
[16:35:30.904] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:35:30.904] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:151:0) after 1m0s
[16:36:30.906] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:151:0)
[16:36:30.906] Timer tick, asking Buildbucket for the build status
[16:36:31.046] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:36:31.047] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:152:0) after 1m0s
[16:37:31.476] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:152:0)
[16:37:31.476] Timer tick, asking Buildbucket for the build status
[16:37:31.746] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:37:31.746] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:153:0) after 1m0s
[16:38:32.705] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:153:0)
[16:38:32.705] Timer tick, asking Buildbucket for the build status
[16:38:32.980] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:38:32.980] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:154:0) after 1m0s
[16:39:32.976] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:154:0)
[16:39:32.976] Timer tick, asking Buildbucket for the build status
[16:39:33.089] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:39:33.089] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:155:0) after 1m0s
[16:40:33.106] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:155:0)
[16:40:33.106] Timer tick, asking Buildbucket for the build status
[16:40:34.327] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:40:34.327] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:156:0) after 1m0s
[16:41:34.409] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:156:0)
[16:41:34.409] Timer tick, asking Buildbucket for the build status
[16:41:34.904] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:41:34.904] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:157:0) after 1m0s
[16:42:34.940] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:157:0)
[16:42:34.940] Timer tick, asking Buildbucket for the build status
[16:42:35.157] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:42:35.157] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:158:0) after 1m0s
[16:43:35.241] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:158:0)
[16:43:35.241] Timer tick, asking Buildbucket for the build status
[16:43:35.379] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:43:35.379] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:159:0) after 1m0s
[16:44:35.439] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:159:0)
[16:44:35.439] Timer tick, asking Buildbucket for the build status
[16:44:35.623] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:44:35.623] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:160:0) after 1m0s
[16:45:35.701] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:160:0)
[16:45:35.701] Timer tick, asking Buildbucket for the build status
[16:45:35.826] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:45:35.827] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:161:0) after 1m0s
[16:46:36.104] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:161:0)
[16:46:36.104] Timer tick, asking Buildbucket for the build status
[16:46:36.412] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:46:36.412] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:162:0) after 1m0s
[16:47:36.583] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:162:0)
[16:47:36.583] Timer tick, asking Buildbucket for the build status
[16:47:36.765] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:47:36.765] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:163:0) after 1m0s
[16:48:37.001] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:163:0)
[16:48:37.001] Timer tick, asking Buildbucket for the build status
[16:48:37.625] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:48:37.625] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:164:0) after 1m0s
[16:49:37.742] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:164:0)
[16:49:37.742] Timer tick, asking Buildbucket for the build status
[16:49:38.015] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:49:38.015] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:165:0) after 1m0s
[16:50:38.137] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:165:0)
[16:50:38.137] Timer tick, asking Buildbucket for the build status
[16:50:38.283] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:50:38.283] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:166:0) after 1m0s
[16:51:38.404] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:166:0)
[16:51:38.404] Timer tick, asking Buildbucket for the build status
[16:51:38.610] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:51:38.611] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:167:0) after 1m0s
[16:52:38.773] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:167:0)
[16:52:38.773] Timer tick, asking Buildbucket for the build status
[16:52:39.232] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:52:39.232] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:168:0) after 1m0s
[16:53:39.560] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:168:0)
[16:53:39.560] Timer tick, asking Buildbucket for the build status
[16:53:39.769] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:53:39.769] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:169:0) after 1m0s
[16:54:40.028] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:169:0)
[16:54:40.028] Timer tick, asking Buildbucket for the build status
[16:54:40.304] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:54:40.304] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:170:0) after 1m0s
[16:55:40.494] Handling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:170:0)
[16:55:40.494] Timer tick, asking Buildbucket for the build status
[16:55:41.546] Build 8875154673159095408: status "STARTED", result "", failure_reason "", cancelation_reason ""
[16:55:41.546] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOS:9040584735738632976:171:0) after 1m0s
[16:56:37.532] Received PubSub notification, asking Buildbucket for the build status
[16:56:37.641] Build 8875154673159095408: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[16:56:37.641] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1594400196593817",
"created_by": "project:chromium",
"created_ts": "1594389956283861",
"failure_reason": "BUILD_FAILURE",
"id": "8875154673159095408",
"parameters_json": "{\"builder_name\": \"ToTiOS\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"8734154bae4101e4911b8c9178d432286c636c20\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"1 Test Suite(s) failed.\\n\\n**ios_chrome_unittests_iPhone 6s 13.4** failed because of:\\n\\n- URLOpenerTest.VerifyLaunchOptionsWithNoSourceApplication\\n\\n- OverlayPresentationContextImplTest.ContainedOverlayUI\"}, \"properties\": {\"$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\": \"build283-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"ToTiOS\", \"buildnumber\": 14970, \"clang_revision\": \"n358615-fb1aa286-3\", \"got_angle_revision\": \"eb0f83b8edc5d1c6b57dbced951a16e3e1202ca2\", \"got_dawn_revision\": \"479689912ee2fa90e38b4b367dbc4a1925ff9a08\", \"got_nacl_revision\": \"fd20fafa8ec19700e12daa031bf792bae8b6bb21\", \"got_revision\": \"8734154bae4101e4911b8c9178d432286c636c20\", \"got_revision_cp\": \"refs/heads/master@{#787190}\", \"got_swarming_client_revision\": \"4c095d04179dc725a300085ae21fe3b79900d072\", \"got_swiftshader_revision\": \"6cd27bab06f428386b9acb5241c1d50d8a290a5c\", \"got_v8_revision\": \"4e61c4410431ddf386dbb03a107a44522da0af44\", \"got_v8_revision_cp\": \"refs/heads/8.6.105@{#1}\", \"got_webrtc_revision\": \"f7303e64864f875ac710edaed3f318fe2a635fe9\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31694}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mastername\": \"chromium.clang\", \"path_config\": \"generic\", \"perf_dashboard_machine_group\": \"ChromiumClang\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"8734154bae4101e4911b8c9178d432286c636c20\", \"swarm_hashes\": {\"absl_hardening_tests\": \"372ff6bcc22d21c8c55a1e80c17aab6c7f5b11ce\", \"base_unittests\": \"fb463b188dd85f0406761db682662338c4f45ccd\", \"boringssl_crypto_tests\": \"05b9ef3a262d82b8738bd5869cecbc05d7222abf\", \"boringssl_ssl_tests\": \"bbaaf10dab1a91aada595b3232dcdd3e3b95c75e\", \"components_unittests\": \"b59810cb9f9512a9d42a9f36bded37754e561421\", \"crypto_unittests\": \"0122554af47ea342a762e698d8b31b3e148cf77c\", \"gfx_unittests\": \"551663dbb91d4515ebe49ec3f670512fc4f71698\", \"google_apis_unittests\": \"c32d136ccb7a5b8cf5d03047d0a1114cca9aba36\", \"ios_chrome_unittests\": \"48dd671ee4bc7525da1bfec713f43e47a68610d6\", \"ios_net_unittests\": \"7f2b8532ebafa119341f44c2f1d8a1b5e9005401\", \"ios_web_inttests\": \"67f40b15bfa7043e933dcee296e4b20524d1bfd8\", \"ios_web_unittests\": \"77a6150eb6bcc584c76a08e72e6fa2b0ffb069b8\", \"ios_web_view_inttests\": \"4dc46f5fc3509516e724bebe5b6f74cc67c15345\", \"net_unittests\": \"71848208f1ba505bc3d9da8416f2cd3030062e3f\", \"skia_unittests\": \"5b0f492b968870d571f32170dae8542342887ac4\", \"sql_unittests\": \"80f3c810f04aac9efa52585827c1a09dfdc9f8c0\", \"ui_base_unittests\": \"61605d31954a7bab4f74ff9a6f3758a00c776aaa\", \"url_unittests\": \"498f876d5ebd71d7df3c145a0c4f11ad9e124af7\"}, \"swarm_hashes_refs/heads/master(at){#787190}_without_patch\": {\"absl_hardening_tests\": \"372ff6bcc22d21c8c55a1e80c17aab6c7f5b11ce\", \"base_unittests\": \"fb463b188dd85f0406761db682662338c4f45ccd\", \"boringssl_crypto_tests\": \"05b9ef3a262d82b8738bd5869cecbc05d7222abf\", \"boringssl_ssl_tests\": \"bbaaf10dab1a91aada595b3232dcdd3e3b95c75e\", \"components_unittests\": \"b59810cb9f9512a9d42a9f36bded37754e561421\", \"crypto_unittests\": \"0122554af47ea342a762e698d8b31b3e148cf77c\", \"gfx_unittests\": \"551663dbb91d4515ebe49ec3f670512fc4f71698\", \"google_apis_unittests\": \"c32d136ccb7a5b8cf5d03047d0a1114cca9aba36\", \"ios_chrome_unittests\": \"48dd671ee4bc7525da1bfec713f43e47a68610d6\", \"ios_net_unittests\": \"7f2b8532ebafa119341f44c2f1d8a1b5e9005401\", \"ios_web_inttests\": \"67f40b15bfa7043e933dcee296e4b20524d1bfd8\", \"ios_web_unittests\": \"77a6150eb6bcc584c76a08e72e6fa2b0ffb069b8\", \"ios_web_view_inttests\": \"4dc46f5fc3509516e724bebe5b6f74cc67c15345\", \"net_unittests\": \"71848208f1ba505bc3d9da8416f2cd3030062e3f\", \"skia_unittests\": \"5b0f492b968870d571f32170dae8542342887ac4\", \"sql_unittests\": \"80f3c810f04aac9efa52585827c1a09dfdc9f8c0\", \"ui_base_unittests\": \"61605d31954a7bab4f74ff9a6f3758a00c776aaa\", \"url_unittests\": \"498f876d5ebd71d7df3c145a0c4f11ad9e124af7\"}, \"xcode_build_version\": \"11c29\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_0c96c161cf7dd2e1c2b922319da904a0c0164c4adceed5a8844a45f1c516ad13_v2\", \"builder_4a4feefdd7e355061708c01720b06a0ca8c49ffc9968a2ebc674541738676b8f_v2\", \"builder_69caa34b8f39daac28a821cac2619730401d46a6479812cc34796e3bf180418a_v2\", \"builder_ae5debd901c74ee0906916cb62621bceb2a8b657b42c2e2e9e89a0f6a2e5e53b_v2\", \"builder_d42b89eab403033f5a2a8102ec9c436397350cedb439d5e09b11874a5784adb4_v2\", \"git\", \"goma_v2\", \"vpython\", \"xcode_ios_11c29\"], \"cores\": [\"24\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-E5-2697_v2\"], \"gce\": [\"0\"], \"gpu\": [\"1002\", \"1002:679e\", \"1002:679e-4.0.11-3.2.8\"], \"hidpi\": [\"0\"], \"id\": [\"build283-m9\"], \"mac_model\": [\"MacPro6,1\"], \"machine_type\": [\"n1-standard-16\"], \"os\": [\"Mac\", \"Mac-10.14\", \"Mac-10.14.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.10\"], \"server_version\": [\"5378-e275056\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}, \"ui\": {\"info\": \"1 Test Suite(s) failed.\\n\\n**ios_chrome_unittests_iPhone 6s 13.4** failed because of:\\n\\n- URLOpenerTest.VerifyLaunchOptionsWithNoSourceApplication\\n\\n- OverlayPresentationContextImplTest.ContainedOverlayUI\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1594390195620697",
"status": "COMPLETED",
"status_changed_ts": "1594390196005177",
"tags": [
"build_address:luci.chromium.ci/ToTiOS/14970",
"builder:ToTiOS",
"buildset:commit/git/8734154bae4101e4911b8c9178d432286c636c20",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/8734154bae4101e4911b8c9178d432286c636c20",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9040584735738632976",
"scheduler_job_id:chromium/ToTiOS",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8875154673159095408/+/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:4d51dd9eed6dc110",
"user_agent:luci-scheduler"
],
"updated_ts": "1594400196695252",
"url": "https://ci.chromium.org/b/8875154673159095408",
"utcnow_ts": "1594400197633335"
}
}
[16:56:37.641] Invocation finished in 2h50m43.201463165s with status FAILED