[17:33:10.152] New invocation is queued and will start shortly
[17:33:11.255] Starting the invocation (attempt 1)
[17:33:11.289] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[17:33:11.664] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[17:33:11.664] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9073005409940738800",
"parameters_json": "{\"builder_name\":\"ToTiOSDevice\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src.git\",\"revision\":\"b9e141f07ee5284ea9a160c822c5a89f167c73a4\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:ToTiOSDevice",
"scheduler_invocation_id:9073005409940738800",
"scheduler_job_id:chromium/ToTiOSDevice",
"user_agent:luci-scheduler",
"buildset:commit/git/b9e141f07ee5284ea9a160c822c5a89f167c73a4",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/b9e141f07ee5284ea9a160c822c5a89f167c73a4",
"gitiles_ref:refs/heads/master"
]
}
[17:33:12.921] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1563471192124870",
"id": "8907575347205593120",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"b9e141f07ee5284ea9a160c822c5a89f167c73a4\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1563471192675898",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/13001",
"builder:ToTiOSDevice",
"buildset:commit/git/b9e141f07ee5284ea9a160c822c5a89f167c73a4",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/b9e141f07ee5284ea9a160c822c5a89f167c73a4",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9073005409940738800",
"scheduler_job_id:chromium/ToTiOSDevice",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8907575347205593120/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:ios/unified_builder_tester",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1563471192675997",
"url": "https://ci.chromium.org/b/8907575347205593120",
"utcnow_ts": "1563471192889399"
}
}
[17:33:12.921] Task URL: https://ci.chromium.org/b/8907575347205593120
[17:33:12.921] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:2:0) after 1m0s
[17:34:13.024] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:2:0)
[17:34:13.024] Timer tick, asking Buildbucket for the build status
[17:34:13.828] Build 8907575347205593120: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:34:13.828] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:3:0) after 1m0s
[17:35:14.026] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:3:0)
[17:35:14.026] Timer tick, asking Buildbucket for the build status
[17:35:14.392] Build 8907575347205593120: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[17:35:14.392] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:4:0) after 1m0s
[17:35:31.063] Received PubSub notification, asking Buildbucket for the build status
[17:35:31.250] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:36:14.536] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:4:0)
[17:36:14.536] Timer tick, asking Buildbucket for the build status
[17:36:14.847] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:36:14.847] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:6:0) after 1m0s
[17:37:14.822] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:6:0)
[17:37:14.822] Timer tick, asking Buildbucket for the build status
[17:37:15.218] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:37:15.218] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:7:0) after 1m0s
[17:38:15.304] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:7:0)
[17:38:15.304] Timer tick, asking Buildbucket for the build status
[17:38:15.686] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:38:15.686] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:8:0) after 1m0s
[17:39:15.739] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:8:0)
[17:39:15.739] Timer tick, asking Buildbucket for the build status
[17:39:15.948] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:39:15.948] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:9:0) after 1m0s
[17:40:16.025] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:9:0)
[17:40:16.025] Timer tick, asking Buildbucket for the build status
[17:40:16.501] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:40:16.501] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:10:0) after 1m0s
[17:41:16.604] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:10:0)
[17:41:16.604] Timer tick, asking Buildbucket for the build status
[17:41:16.827] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:41:16.827] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:11:0) after 1m0s
[17:42:17.072] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:11:0)
[17:42:17.072] Timer tick, asking Buildbucket for the build status
[17:42:17.369] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:42:17.369] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:12:0) after 1m0s
[17:43:17.424] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:12:0)
[17:43:17.424] Timer tick, asking Buildbucket for the build status
[17:43:17.653] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:43:17.653] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:13:0) after 1m0s
[17:44:17.676] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:13:0)
[17:44:17.676] Timer tick, asking Buildbucket for the build status
[17:44:18.820] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:44:18.820] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:14:0) after 1m0s
[17:45:18.973] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:14:0)
[17:45:18.973] Timer tick, asking Buildbucket for the build status
[17:45:23.884] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:45:23.884] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:15:0) after 1m0s
[17:46:24.042] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:15:0)
[17:46:24.042] Timer tick, asking Buildbucket for the build status
[17:46:24.485] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:46:24.485] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:16:0) after 1m0s
[17:47:24.644] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:16:0)
[17:47:24.644] Timer tick, asking Buildbucket for the build status
[17:47:25.278] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:47:25.278] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:17:0) after 1m0s
[17:48:25.304] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:17:0)
[17:48:25.304] Timer tick, asking Buildbucket for the build status
[17:48:30.085] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:48:30.085] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:18:0) after 1m0s
[17:49:30.258] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:18:0)
[17:49:30.258] Timer tick, asking Buildbucket for the build status
[17:49:30.454] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:49:30.454] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:19:0) after 1m0s
[17:50:30.573] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:19:0)
[17:50:30.573] Timer tick, asking Buildbucket for the build status
[17:50:30.877] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:50:30.877] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:20:0) after 1m0s
[17:51:30.912] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:20:0)
[17:51:30.912] Timer tick, asking Buildbucket for the build status
[17:51:31.114] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:51:31.114] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:21:0) after 1m0s
[17:52:31.158] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:21:0)
[17:52:31.158] Timer tick, asking Buildbucket for the build status
[17:52:31.403] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:52:31.403] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:22:0) after 1m0s
[17:53:31.460] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:22:0)
[17:53:31.460] Timer tick, asking Buildbucket for the build status
[17:53:31.769] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:53:31.769] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:23:0) after 1m0s
[17:54:31.760] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:23:0)
[17:54:31.760] Timer tick, asking Buildbucket for the build status
[17:54:35.517] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:54:35.517] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:24:0) after 1m0s
[17:55:35.571] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:24:0)
[17:55:35.571] Timer tick, asking Buildbucket for the build status
[17:55:35.996] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:55:35.996] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:25:0) after 1m0s
[17:56:36.042] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:25:0)
[17:56:36.042] Timer tick, asking Buildbucket for the build status
[17:56:36.425] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:56:36.425] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:26:0) after 1m0s
[17:57:36.468] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:26:0)
[17:57:36.468] Timer tick, asking Buildbucket for the build status
[17:57:37.162] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:57:37.162] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:27:0) after 1m0s
[17:58:37.193] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:27:0)
[17:58:37.193] Timer tick, asking Buildbucket for the build status
[17:58:37.753] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:58:37.753] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:28:0) after 1m0s
[17:59:37.898] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:28:0)
[17:59:37.898] Timer tick, asking Buildbucket for the build status
[17:59:38.838] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[17:59:38.838] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:29:0) after 1m0s
[18:00:38.871] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:29:0)
[18:00:38.871] Timer tick, asking Buildbucket for the build status
[18:00:39.458] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:00:39.458] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:30:0) after 1m0s
[18:01:39.478] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:30:0)
[18:01:39.478] Timer tick, asking Buildbucket for the build status
[18:01:39.876] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:01:39.876] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:31:0) after 1m0s
[18:02:39.881] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:31:0)
[18:02:39.881] Timer tick, asking Buildbucket for the build status
[18:02:40.598] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:02:40.598] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:32:0) after 1m0s
[18:03:40.674] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:32:0)
[18:03:40.674] Timer tick, asking Buildbucket for the build status
[18:03:40.816] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:03:40.816] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:33:0) after 1m0s
[18:04:40.924] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:33:0)
[18:04:40.924] Timer tick, asking Buildbucket for the build status
[18:04:41.242] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:04:41.242] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:34:0) after 1m0s
[18:05:41.313] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:34:0)
[18:05:41.313] Timer tick, asking Buildbucket for the build status
[18:05:41.570] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:05:41.570] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:35:0) after 1m0s
[18:06:41.590] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:35:0)
[18:06:41.590] Timer tick, asking Buildbucket for the build status
[18:06:45.076] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:06:45.076] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:36:0) after 1m0s
[18:07:45.110] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:36:0)
[18:07:45.110] Timer tick, asking Buildbucket for the build status
[18:07:45.861] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:07:45.861] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:37:0) after 1m0s
[18:08:45.959] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:37:0)
[18:08:45.959] Timer tick, asking Buildbucket for the build status
[18:08:46.114] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:08:46.114] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:38:0) after 1m0s
[18:09:46.132] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:38:0)
[18:09:46.132] Timer tick, asking Buildbucket for the build status
[18:09:48.073] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:09:48.073] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:39:0) after 1m0s
[18:10:48.128] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:39:0)
[18:10:48.128] Timer tick, asking Buildbucket for the build status
[18:10:48.395] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:10:48.395] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:40:0) after 1m0s
[18:11:48.401] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:40:0)
[18:11:48.401] Timer tick, asking Buildbucket for the build status
[18:11:49.359] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:11:49.359] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:41:0) after 1m0s
[18:12:49.352] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:41:0)
[18:12:49.352] Timer tick, asking Buildbucket for the build status
[18:12:49.574] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:12:49.574] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:42:0) after 1m0s
[18:13:49.609] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:42:0)
[18:13:49.609] Timer tick, asking Buildbucket for the build status
[18:13:50.821] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:13:50.821] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:43:0) after 1m0s
[18:14:50.863] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:43:0)
[18:14:50.863] Timer tick, asking Buildbucket for the build status
[18:14:51.126] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:14:51.126] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:44:0) after 1m0s
[18:15:51.149] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:44:0)
[18:15:51.149] Timer tick, asking Buildbucket for the build status
[18:15:53.346] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:15:53.346] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:45:0) after 1m0s
[18:16:53.381] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:45:0)
[18:16:53.381] Timer tick, asking Buildbucket for the build status
[18:16:53.619] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:16:53.619] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:46:0) after 1m0s
[18:17:53.679] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:46:0)
[18:17:53.679] Timer tick, asking Buildbucket for the build status
[18:17:54.873] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:17:54.873] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:47:0) after 1m0s
[18:18:54.981] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:47:0)
[18:18:54.981] Timer tick, asking Buildbucket for the build status
[18:18:55.418] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:18:55.418] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:48:0) after 1m0s
[18:19:55.478] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:48:0)
[18:19:55.478] Timer tick, asking Buildbucket for the build status
[18:19:55.654] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:19:55.654] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:49:0) after 1m0s
[18:20:55.702] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:49:0)
[18:20:55.702] Timer tick, asking Buildbucket for the build status
[18:20:56.636] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:20:56.636] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:50:0) after 1m0s
[18:21:56.732] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:50:0)
[18:21:56.732] Timer tick, asking Buildbucket for the build status
[18:21:57.739] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:21:57.739] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:51:0) after 1m0s
[18:22:57.867] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:51:0)
[18:22:57.867] Timer tick, asking Buildbucket for the build status
[18:22:58.007] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:22:58.007] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:52:0) after 1m0s
[18:23:58.121] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:52:0)
[18:23:58.121] Timer tick, asking Buildbucket for the build status
[18:23:58.479] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:23:58.479] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:53:0) after 1m0s
[18:24:58.650] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:53:0)
[18:24:58.650] Timer tick, asking Buildbucket for the build status
[18:24:58.805] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:24:58.805] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:54:0) after 1m0s
[18:25:58.914] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:54:0)
[18:25:58.914] Timer tick, asking Buildbucket for the build status
[18:25:59.113] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:25:59.113] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:55:0) after 1m0s
[18:26:59.182] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:55:0)
[18:26:59.182] Timer tick, asking Buildbucket for the build status
[18:26:59.293] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:26:59.293] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:56:0) after 1m0s
[18:27:59.402] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:56:0)
[18:27:59.402] Timer tick, asking Buildbucket for the build status
[18:27:59.546] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:27:59.546] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:57:0) after 1m0s
[18:28:59.678] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:57:0)
[18:28:59.678] Timer tick, asking Buildbucket for the build status
[18:29:00.474] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:29:00.474] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:58:0) after 1m0s
[18:30:00.542] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:58:0)
[18:30:00.542] Timer tick, asking Buildbucket for the build status
[18:30:02.102] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:30:02.102] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:59:0) after 1m0s
[18:31:02.196] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:59:0)
[18:31:02.196] Timer tick, asking Buildbucket for the build status
[18:31:02.338] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:31:02.338] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:60:0) after 1m0s
[18:32:02.393] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:60:0)
[18:32:02.393] Timer tick, asking Buildbucket for the build status
[18:32:05.326] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:32:05.326] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:61:0) after 1m0s
[18:33:05.415] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:61:0)
[18:33:05.416] Timer tick, asking Buildbucket for the build status
[18:33:06.292] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:33:06.292] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:62:0) after 1m0s
[18:34:06.412] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:62:0)
[18:34:06.412] Timer tick, asking Buildbucket for the build status
[18:34:07.235] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:34:07.235] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:63:0) after 1m0s
[18:35:07.295] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:63:0)
[18:35:07.295] Timer tick, asking Buildbucket for the build status
[18:35:07.647] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:35:07.647] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:64:0) after 1m0s
[18:36:07.643] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:64:0)
[18:36:07.643] Timer tick, asking Buildbucket for the build status
[18:36:07.850] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:36:07.850] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:65:0) after 1m0s
[18:37:07.987] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:65:0)
[18:37:07.988] Timer tick, asking Buildbucket for the build status
[18:37:08.661] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:37:08.661] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:66:0) after 1m0s
[18:38:08.733] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:66:0)
[18:38:08.733] Timer tick, asking Buildbucket for the build status
[18:38:08.981] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:38:08.981] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:67:0) after 1m0s
[18:39:09.016] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:67:0)
[18:39:09.016] Timer tick, asking Buildbucket for the build status
[18:39:10.338] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:39:10.338] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:68:0) after 1m0s
[18:40:10.373] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:68:0)
[18:40:10.373] Timer tick, asking Buildbucket for the build status
[18:40:10.930] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:40:10.930] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:69:0) after 1m0s
[18:41:11.060] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:69:0)
[18:41:11.060] Timer tick, asking Buildbucket for the build status
[18:41:11.727] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:41:11.727] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:70:0) after 1m0s
[18:42:11.786] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:70:0)
[18:42:11.786] Timer tick, asking Buildbucket for the build status
[18:42:13.894] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:42:13.894] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:71:0) after 1m0s
[18:43:13.985] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:71:0)
[18:43:13.985] Timer tick, asking Buildbucket for the build status
[18:43:14.227] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:43:14.227] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:72:0) after 1m0s
[18:44:14.359] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:72:0)
[18:44:14.359] Timer tick, asking Buildbucket for the build status
[18:44:14.508] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:44:14.508] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:73:0) after 1m0s
[18:45:14.554] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:73:0)
[18:45:14.554] Timer tick, asking Buildbucket for the build status
[18:45:15.911] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:45:15.911] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:74:0) after 1m0s
[18:46:15.952] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:74:0)
[18:46:15.952] Timer tick, asking Buildbucket for the build status
[18:46:17.040] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:46:17.040] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:75:0) after 1m0s
[18:47:17.142] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:75:0)
[18:47:17.142] Timer tick, asking Buildbucket for the build status
[18:47:17.378] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:17.378] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:76:0) after 1m0s
[18:48:17.484] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:76:0)
[18:48:17.484] Timer tick, asking Buildbucket for the build status
[18:48:18.148] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:48:18.148] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:77:0) after 1m0s
[18:49:18.178] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:77:0)
[18:49:18.178] Timer tick, asking Buildbucket for the build status
[18:49:18.652] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:49:18.652] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:78:0) after 1m0s
[18:50:18.711] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:78:0)
[18:50:18.711] Timer tick, asking Buildbucket for the build status
[18:50:20.310] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:20.310] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:79:0) after 1m0s
[18:51:20.534] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:79:0)
[18:51:20.534] Timer tick, asking Buildbucket for the build status
[18:51:20.742] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:51:20.742] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:80:0) after 1m0s
[18:52:20.781] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:80:0)
[18:52:20.781] Timer tick, asking Buildbucket for the build status
[18:52:20.891] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:52:20.891] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:81:0) after 1m0s
[18:53:20.989] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:81:0)
[18:53:20.989] Timer tick, asking Buildbucket for the build status
[18:53:21.399] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:53:21.399] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:82:0) after 1m0s
[18:54:21.461] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:82:0)
[18:54:21.461] Timer tick, asking Buildbucket for the build status
[18:54:22.518] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:54:22.518] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:83:0) after 1m0s
[18:55:22.562] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:83:0)
[18:55:22.562] Timer tick, asking Buildbucket for the build status
[18:55:22.729] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:55:22.729] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:84:0) after 1m0s
[18:56:22.735] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:84:0)
[18:56:22.735] Timer tick, asking Buildbucket for the build status
[18:56:23.123] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:56:23.123] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:85:0) after 1m0s
[18:57:23.234] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:85:0)
[18:57:23.234] Timer tick, asking Buildbucket for the build status
[18:57:24.328] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:57:24.328] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:86:0) after 1m0s
[18:58:24.361] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:86:0)
[18:58:24.361] Timer tick, asking Buildbucket for the build status
[18:58:25.716] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:25.716] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:87:0) after 1m0s
[18:59:25.744] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:87:0)
[18:59:25.744] Timer tick, asking Buildbucket for the build status
[18:59:26.044] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:59:26.044] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:88:0) after 1m0s
[19:00:26.058] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:88:0)
[19:00:26.058] Timer tick, asking Buildbucket for the build status
[19:00:26.422] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:00:26.423] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:89:0) after 1m0s
[19:01:26.487] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:89:0)
[19:01:26.487] Timer tick, asking Buildbucket for the build status
[19:01:27.007] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:01:27.007] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:90:0) after 1m0s
[19:02:27.084] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:90:0)
[19:02:27.084] Timer tick, asking Buildbucket for the build status
[19:02:27.580] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:02:27.580] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:91:0) after 1m0s
[19:03:27.578] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:91:0)
[19:03:27.578] Timer tick, asking Buildbucket for the build status
[19:03:27.797] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:03:27.797] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:92:0) after 1m0s
[19:04:27.813] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:92:0)
[19:04:27.813] Timer tick, asking Buildbucket for the build status
[19:04:30.566] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:04:30.569] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:93:0) after 1m0s
[19:05:30.604] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:93:0)
[19:05:30.604] Timer tick, asking Buildbucket for the build status
[19:05:30.830] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:05:30.830] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:94:0) after 1m0s
[19:06:30.873] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:94:0)
[19:06:30.873] Timer tick, asking Buildbucket for the build status
[19:06:31.516] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:06:31.516] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:95:0) after 1m0s
[19:07:31.565] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:95:0)
[19:07:31.565] Timer tick, asking Buildbucket for the build status
[19:07:32.038] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:07:32.038] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:96:0) after 1m0s
[19:08:32.157] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:96:0)
[19:08:32.157] Timer tick, asking Buildbucket for the build status
[19:08:32.384] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:08:32.384] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:97:0) after 1m0s
[19:09:32.472] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:97:0)
[19:09:32.472] Timer tick, asking Buildbucket for the build status
[19:09:32.880] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:09:32.880] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:98:0) after 1m0s
[19:10:33.037] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:98:0)
[19:10:33.037] Timer tick, asking Buildbucket for the build status
[19:10:33.311] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:10:33.311] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:99:0) after 1m0s
[19:11:33.420] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:99:0)
[19:11:33.420] Timer tick, asking Buildbucket for the build status
[19:11:33.639] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:11:33.639] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:100:0) after 1m0s
[19:12:33.708] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:100:0)
[19:12:33.708] Timer tick, asking Buildbucket for the build status
[19:12:33.887] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:12:33.887] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:101:0) after 1m0s
[19:13:33.955] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:101:0)
[19:13:33.955] Timer tick, asking Buildbucket for the build status
[19:13:34.209] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:13:34.209] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:102:0) after 1m0s
[19:14:34.284] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:102:0)
[19:14:34.284] Timer tick, asking Buildbucket for the build status
[19:14:35.746] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:14:35.746] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:103:0) after 1m0s
[19:15:35.804] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:103:0)
[19:15:35.804] Timer tick, asking Buildbucket for the build status
[19:15:36.099] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:15:36.099] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:104:0) after 1m0s
[19:16:36.211] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:104:0)
[19:16:36.211] Timer tick, asking Buildbucket for the build status
[19:16:36.943] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:16:36.943] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:105:0) after 1m0s
[19:17:37.202] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:105:0)
[19:17:37.202] Timer tick, asking Buildbucket for the build status
[19:17:37.609] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:17:37.609] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:106:0) after 1m0s
[19:18:37.783] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:106:0)
[19:18:37.783] Timer tick, asking Buildbucket for the build status
[19:18:37.951] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:18:37.951] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:107:0) after 1m0s
[19:19:38.145] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:107:0)
[19:19:38.145] Timer tick, asking Buildbucket for the build status
[19:19:38.328] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:19:38.328] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:108:0) after 1m0s
[19:20:38.481] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:108:0)
[19:20:38.481] Timer tick, asking Buildbucket for the build status
[19:20:38.760] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:20:38.760] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:109:0) after 1m0s
[19:21:38.842] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:109:0)
[19:21:38.842] Timer tick, asking Buildbucket for the build status
[19:21:39.159] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:21:39.159] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:110:0) after 1m0s
[19:22:39.270] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:110:0)
[19:22:39.270] Timer tick, asking Buildbucket for the build status
[19:22:40.023] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:22:40.023] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:111:0) after 1m0s
[19:23:40.131] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:111:0)
[19:23:40.131] Timer tick, asking Buildbucket for the build status
[19:23:40.526] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:23:40.526] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:112:0) after 1m0s
[19:24:40.665] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:112:0)
[19:24:40.665] Timer tick, asking Buildbucket for the build status
[19:24:44.614] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:24:44.614] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:113:0) after 1m0s
[19:25:44.644] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:113:0)
[19:25:44.644] Timer tick, asking Buildbucket for the build status
[19:25:45.802] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:25:45.802] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:114:0) after 1m0s
[19:26:45.919] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:114:0)
[19:26:45.919] Timer tick, asking Buildbucket for the build status
[19:26:47.656] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:26:47.657] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:115:0) after 1m0s
[19:27:47.877] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:115:0)
[19:27:47.877] Timer tick, asking Buildbucket for the build status
[19:27:48.385] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:27:48.385] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:116:0) after 1m0s
[19:28:48.470] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:116:0)
[19:28:48.470] Timer tick, asking Buildbucket for the build status
[19:28:48.630] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:28:48.630] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:117:0) after 1m0s
[19:29:48.755] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:117:0)
[19:29:48.755] Timer tick, asking Buildbucket for the build status
[19:29:49.306] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:29:49.306] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:118:0) after 1m0s
[19:30:49.369] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:118:0)
[19:30:49.369] Timer tick, asking Buildbucket for the build status
[19:30:50.050] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:30:50.050] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:119:0) after 1m0s
[19:31:50.224] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:119:0)
[19:31:50.224] Timer tick, asking Buildbucket for the build status
[19:31:51.494] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:31:51.494] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:120:0) after 1m0s
[19:32:51.642] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:120:0)
[19:32:51.642] Timer tick, asking Buildbucket for the build status
[19:32:51.882] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:32:51.882] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:121:0) after 1m0s
[19:33:52.132] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:121:0)
[19:33:52.132] Timer tick, asking Buildbucket for the build status
[19:33:55.766] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:33:55.766] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:122:0) after 1m0s
[19:34:55.868] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:122:0)
[19:34:55.868] Timer tick, asking Buildbucket for the build status
[19:34:56.118] Build 8907575347205593120: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:34:56.118] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9073005409940738800:123:0) after 1m0s
[19:35:48.145] Received PubSub notification, asking Buildbucket for the build status
[19:35:48.368] Build 8907575347205593120: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[19:35:48.368] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1563478547551689",
"created_by": "project:chromium",
"created_ts": "1563471192124870",
"failure_reason": "BUILD_FAILURE",
"id": "8907575347205593120",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"b9e141f07ee5284ea9a160c822c5a89f167c73a4\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Failed base_unittests (iPhone 6s iOS 12.3.1), boringssl_crypto_tests (iPhone 6s iOS 12.3.1), boringssl_ssl_tests (iPhone 6s iOS 12.3.1), components_unittests (iPhone 6s iOS 12.3.1), crypto_unittests (iPhone 6s iOS 12.3.1), gfx_unittests (iPhone 6s iOS 12.3.1), google_apis_unittests (iPhone 6s iOS 12.3.1), ios_chrome_unittests (iPhone 6s iOS 12.3.1), ios_net_unittests (iPhone 6s iOS 12.3.1), ios_web_inttests (iPhone 6s iOS 12.3.1), ios_web_unittests (iPhone 6s iOS 12.3.1), ios_web_view_inttests (iPhone 6s iOS 12.3.1), net_unittests (iPhone 6s iOS 12.3.1), skia_unittests (iPhone 6s iOS 12.3.1), sql_unittests (iPhone 6s iOS 12.3.1), ui_base_unittests (iPhone 6s iOS 12.3.1), url_unittests (iPhone 6s iOS 12.3.1).\"}, \"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\": \"build284-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"ToTiOSDevice\", \"buildnumber\": 13001, \"got_angle_revision\": \"27ee35e6274bf701f6c417f44609dca69208799f\", \"got_dawn_revision\": \"1546bfbdecf26566b9042235e70feb19c2652958\", \"got_nacl_revision\": \"058a26f57015051953a727add26e7e26348b9558\", \"got_revision\": \"b9e141f07ee5284ea9a160c822c5a89f167c73a4\", \"got_revision_cp\": \"refs/heads/master@{#678746}\", \"got_swarming_client_revision\": \"96f125709acfd0b48fc1e5dae7d6ea42291726ac\", \"got_v8_revision\": \"648bae735002950e10753042ad0d30615940c29a\", \"got_v8_revision_cp\": \"refs/heads/7.7.270@{#1}\", \"got_webrtc_revision\": \"594597c25df53d13923ebee45135ba300e13fb02\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#28599}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mastername\": \"chromium.clang\", \"path_config\": \"generic\", \"perf_dashboard_machine_group\": \"ChromiumClang\", \"recipe\": \"ios/unified_builder_tester\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"b9e141f07ee5284ea9a160c822c5a89f167c73a4\", \"swarm_hashes\": {\"0\": \"6aa7aa7192b14fbe5d54e66d8d714361681e635a\", \"1\": \"a20b03481813c4680219cd0f0d40d878ce08509f\", \"10\": \"2ca900acbb1335ab3c9f177f9d923444b4e4385e\", \"11\": \"78080c4f3761cb232972af19be86da091160d7f9\", \"12\": \"e00a207eb4a8f965d158dfc7996ce2bb6e50495a\", \"13\": \"8b19c4ddaabe3248c1836a62d3f2fc53fc17a6aa\", \"14\": \"c7fc9c505003518c202fa49c87bcb3394713e9b8\", \"15\": \"e70fd87871b66ed3fe048b9a36b7a73ae0724e04\", \"16\": \"a976aec447d1b960944c526bc7579db9fccceba8\", \"2\": \"ba1fe951e8b9948ce8d5c8610c93608ce0958a07\", \"3\": \"7c2d011e95e376c1f1b6df82d9c4c8ed6511b8ac\", \"4\": \"f228bb335448c94dbf6dca28c104f586a60455ca\", \"5\": \"4819bb4750bc636e988e785678de23c0734ad7d7\", \"6\": \"1435858ed71a4fcf9b0b4a1d1c2963294f1de5d0\", \"7\": \"62677819389594776e9f26dcceff70274418395d\", \"8\": \"cc7a26fe5dd35c7822c6c54679086153358456c6\", \"9\": \"4bada6109a9d613a61346e17d6e35396204a3e4d\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_0c96c161cf7dd2e1c2b922319da904a0c0164c4adceed5a8844a45f1c516ad13_v2\", \"builder_4a4feefdd7e355061708c01720b06a0ca8c49ffc9968a2ebc674541738676b8f_v2\", \"builder_5372538a354f163a20d332d881c6c5d85e35654ac8a57c760866f12033f8a8a5_v2\", \"builder_69caa34b8f39daac28a821cac2619730401d46a6479812cc34796e3bf180418a_v2\", \"builder_ae5debd901c74ee0906916cb62621bceb2a8b657b42c2e2e9e89a0f6a2e5e53b_v2\", \"builder_d42b89eab403033f5a2a8102ec9c436397350cedb439d5e09b11874a5784adb4_v2\", \"git\", \"goma_v2\", \"vpython\", \"xcode_ios_10b61\"], \"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\": [\"build284-m9\"], \"mac_model\": [\"MacPro6,1\"], \"machine_type\": [\"n1-standard-16\"], \"os\": [\"Mac\", \"Mac-10.13\", \"Mac-10.13.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.10\"], \"server_version\": [\"4370-0e704a3\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}, \"ui\": {\"info\": \"Failed base_unittests (iPhone 6s iOS 12.3.1), boringssl_crypto_tests (iPhone 6s iOS 12.3.1), boringssl_ssl_tests (iPhone 6s iOS 12.3.1), components_unittests (iPhone 6s iOS 12.3.1), crypto_unittests (iPhone 6s iOS 12.3.1), gfx_unittests (iPhone 6s iOS 12.3.1), google_apis_unittests (iPhone 6s iOS 12.3.1), ios_chrome_unittests (iPhone 6s iOS 12.3.1), ios_net_unittests (iPhone 6s iOS 12.3.1), ios_web_inttests (iPhone 6s iOS 12.3.1), ios_web_unittests (iPhone 6s iOS 12.3.1), ios_web_view_inttests (iPhone 6s iOS 12.3.1), net_unittests (iPhone 6s iOS 12.3.1), skia_unittests (iPhone 6s iOS 12.3.1), sql_unittests (iPhone 6s iOS 12.3.1), ui_base_unittests (iPhone 6s iOS 12.3.1), url_unittests (iPhone 6s iOS 12.3.1).\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1563471330105587",
"status": "COMPLETED",
"status_changed_ts": "1563471330703324",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/13001",
"builder:ToTiOSDevice",
"buildset:commit/git/b9e141f07ee5284ea9a160c822c5a89f167c73a4",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/b9e141f07ee5284ea9a160c822c5a89f167c73a4",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9073005409940738800",
"scheduler_job_id:chromium/ToTiOSDevice",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8907575347205593120/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Mac",
"swarming_tag:recipe_name:ios/unified_builder_tester",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:461ef6ac07cbc610",
"user_agent:luci-scheduler"
],
"updated_ts": "1563478547651166",
"url": "https://ci.chromium.org/b/8907575347205593120",
"utcnow_ts": "1563478548360706"
}
}
[19:35:48.368] Invocation finished in 2h2m38.236646709s with status FAILED