[00:50:32.472] New invocation is queued and will start shortly
[00:50:33.733] Starting the invocation (attempt 1)
[00:50:33.767] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[00:50:33.767] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[00:50:33.767] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9076511174560669728",
"parameters_json": "{\"builder_name\":\"ToTiOSDevice\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src.git\",\"revision\":\"60c3c6e0ea484417a9918723eab364038cee6c4e\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:ToTiOSDevice",
"scheduler_invocation_id:9076511174560669728",
"scheduler_job_id:chromium/ToTiOSDevice",
"user_agent:luci-scheduler",
"buildset:commit/git/60c3c6e0ea484417a9918723eab364038cee6c4e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/60c3c6e0ea484417a9918723eab364038cee6c4e",
"gitiles_ref:refs/heads/master"
]
}
[00:50:36.312] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1560127834869339",
"id": "8911081111382367840",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"60c3c6e0ea484417a9918723eab364038cee6c4e\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1560127836084514",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/12528",
"builder:ToTiOSDevice",
"buildset:commit/git/60c3c6e0ea484417a9918723eab364038cee6c4e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/60c3c6e0ea484417a9918723eab364038cee6c4e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9076511174560669728",
"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/8911081111382367840/+/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": "1560127836084622",
"url": "https://ci.chromium.org/b/8911081111382367840",
"utcnow_ts": "1560127836292838"
}
}
[00:50:36.312] Task URL: https://ci.chromium.org/b/8911081111382367840
[00:50:36.312] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:2:0) after 1m0s
[00:51:36.370] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:2:0)
[00:51:36.370] Timer tick, asking Buildbucket for the build status
[00:51:36.507] Build 8911081111382367840: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:51:36.507] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:3:0) after 1m0s
[00:52:36.528] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:3:0)
[00:52:36.528] Timer tick, asking Buildbucket for the build status
[00:52:39.414] Build 8911081111382367840: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[00:52:39.414] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:4:0) after 1m0s
[00:52:51.179] Received PubSub notification, asking Buildbucket for the build status
[00:52:52.247] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:39.431] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:4:0)
[00:53:39.431] Timer tick, asking Buildbucket for the build status
[00:53:40.214] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:40.214] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:6:0) after 1m0s
[00:54:40.296] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:6:0)
[00:54:40.296] Timer tick, asking Buildbucket for the build status
[00:54:40.447] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:40.447] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:7:0) after 1m0s
[00:55:40.465] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:7:0)
[00:55:40.465] Timer tick, asking Buildbucket for the build status
[00:55:41.710] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:55:41.710] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:8:0) after 1m0s
[00:56:41.751] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:8:0)
[00:56:41.751] Timer tick, asking Buildbucket for the build status
[00:56:42.186] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:56:42.186] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:9:0) after 1m0s
[00:57:42.179] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:9:0)
[00:57:42.179] Timer tick, asking Buildbucket for the build status
[00:57:43.403] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:57:43.403] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:10:0) after 1m0s
[00:58:43.425] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:10:0)
[00:58:43.425] Timer tick, asking Buildbucket for the build status
[00:58:43.636] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:58:43.636] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:11:0) after 1m0s
[00:59:43.654] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:11:0)
[00:59:43.654] Timer tick, asking Buildbucket for the build status
[00:59:44.795] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:59:44.795] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:12:0) after 1m0s
[01:00:44.812] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:12:0)
[01:00:44.812] Timer tick, asking Buildbucket for the build status
[01:00:45.297] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:00:45.297] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:13:0) after 1m0s
[01:01:45.391] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:13:0)
[01:01:45.391] Timer tick, asking Buildbucket for the build status
[01:01:45.516] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:01:45.516] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:14:0) after 1m0s
[01:02:45.588] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:14:0)
[01:02:45.588] Timer tick, asking Buildbucket for the build status
[01:02:45.727] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:02:45.727] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:15:0) after 1m0s
[01:03:45.829] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:15:0)
[01:03:45.829] Timer tick, asking Buildbucket for the build status
[01:03:46.002] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:03:46.002] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:16:0) after 1m0s
[01:04:46.025] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:16:0)
[01:04:46.025] Timer tick, asking Buildbucket for the build status
[01:04:46.417] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:04:46.417] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:17:0) after 1m0s
[01:05:46.452] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:17:0)
[01:05:46.452] Timer tick, asking Buildbucket for the build status
[01:05:47.098] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:05:47.098] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:18:0) after 1m0s
[01:06:47.119] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:18:0)
[01:06:47.119] Timer tick, asking Buildbucket for the build status
[01:06:47.290] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:06:47.290] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:19:0) after 1m0s
[01:07:47.309] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:19:0)
[01:07:47.309] Timer tick, asking Buildbucket for the build status
[01:07:47.638] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:07:47.638] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:20:0) after 1m0s
[01:08:47.656] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:20:0)
[01:08:47.656] Timer tick, asking Buildbucket for the build status
[01:08:48.692] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:08:48.692] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:21:0) after 1m0s
[01:09:48.715] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:21:0)
[01:09:48.715] Timer tick, asking Buildbucket for the build status
[01:09:50.630] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:09:50.630] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:22:0) after 1m0s
[01:10:50.736] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:22:0)
[01:10:50.736] Timer tick, asking Buildbucket for the build status
[01:10:53.362] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:10:53.362] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:23:0) after 1m0s
[01:11:53.459] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:23:0)
[01:11:53.459] Timer tick, asking Buildbucket for the build status
[01:11:53.763] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:11:53.763] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:24:0) after 1m0s
[01:12:53.830] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:24:0)
[01:12:53.830] Timer tick, asking Buildbucket for the build status
[01:12:54.726] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:12:54.726] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:25:0) after 1m0s
[01:13:54.888] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:25:0)
[01:13:54.888] Timer tick, asking Buildbucket for the build status
[01:13:55.193] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:13:55.193] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:26:0) after 1m0s
[01:14:55.401] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:26:0)
[01:14:55.401] Timer tick, asking Buildbucket for the build status
[01:14:56.211] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:14:56.211] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:27:0) after 1m0s
[01:15:56.245] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:27:0)
[01:15:56.245] Timer tick, asking Buildbucket for the build status
[01:15:56.705] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:15:56.705] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:28:0) after 1m0s
[01:16:56.709] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:28:0)
[01:16:56.709] Timer tick, asking Buildbucket for the build status
[01:16:56.924] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:16:56.924] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:29:0) after 1m0s
[01:17:56.979] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:29:0)
[01:17:56.979] Timer tick, asking Buildbucket for the build status
[01:17:57.366] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:17:57.366] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:30:0) after 1m0s
[01:18:57.386] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:30:0)
[01:18:57.386] Timer tick, asking Buildbucket for the build status
[01:18:58.448] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:18:58.448] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:31:0) after 1m0s
[01:19:58.427] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:31:0)
[01:19:58.427] Timer tick, asking Buildbucket for the build status
[01:19:58.664] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:19:58.664] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:32:0) after 1m0s
[01:20:58.875] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:32:0)
[01:20:58.875] Timer tick, asking Buildbucket for the build status
[01:20:59.039] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:20:59.039] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:33:0) after 1m0s
[01:21:59.126] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:33:0)
[01:21:59.127] Timer tick, asking Buildbucket for the build status
[01:22:00.128] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:22:00.128] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:34:0) after 1m0s
[01:23:00.359] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:34:0)
[01:23:00.359] Timer tick, asking Buildbucket for the build status
[01:23:00.761] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:23:00.761] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:35:0) after 1m0s
[01:24:00.901] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:35:0)
[01:24:00.901] Timer tick, asking Buildbucket for the build status
[01:24:01.450] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:24:01.450] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:36:0) after 1m0s
[01:25:01.569] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:36:0)
[01:25:01.569] Timer tick, asking Buildbucket for the build status
[01:25:01.756] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:25:01.756] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:37:0) after 1m0s
[01:26:01.779] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:37:0)
[01:26:01.779] Timer tick, asking Buildbucket for the build status
[01:26:01.910] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:26:01.910] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:38:0) after 1m0s
[01:27:01.933] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:38:0)
[01:27:01.933] Timer tick, asking Buildbucket for the build status
[01:27:02.186] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:27:02.186] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:39:0) after 1m0s
[01:28:02.207] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:39:0)
[01:28:02.207] Timer tick, asking Buildbucket for the build status
[01:28:02.692] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:28:02.692] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:40:0) after 1m0s
[01:29:02.713] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:40:0)
[01:29:02.713] Timer tick, asking Buildbucket for the build status
[01:29:03.470] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:29:03.470] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:41:0) after 1m0s
[01:30:03.493] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:41:0)
[01:30:03.493] Timer tick, asking Buildbucket for the build status
[01:30:04.273] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:30:04.273] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:42:0) after 1m0s
[01:31:04.296] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:42:0)
[01:31:04.296] Timer tick, asking Buildbucket for the build status
[01:31:05.716] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:31:05.716] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:43:0) after 1m0s
[01:32:05.898] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:43:0)
[01:32:05.898] Timer tick, asking Buildbucket for the build status
[01:32:06.050] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:32:06.050] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:44:0) after 1m0s
[01:33:06.121] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:44:0)
[01:33:06.121] Timer tick, asking Buildbucket for the build status
[01:33:06.481] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:33:06.481] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:45:0) after 1m0s
[01:34:06.501] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:45:0)
[01:34:06.501] Timer tick, asking Buildbucket for the build status
[01:34:07.096] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:34:07.096] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:46:0) after 1m0s
[01:35:07.312] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:46:0)
[01:35:07.312] Timer tick, asking Buildbucket for the build status
[01:35:08.945] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:35:08.946] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:47:0) after 1m0s
[01:36:09.112] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:47:0)
[01:36:09.112] Timer tick, asking Buildbucket for the build status
[01:36:09.655] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:36:09.655] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:48:0) after 1m0s
[01:37:09.752] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:48:0)
[01:37:09.752] Timer tick, asking Buildbucket for the build status
[01:37:11.103] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:37:11.103] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:49:0) after 1m0s
[01:38:11.135] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:49:0)
[01:38:11.135] Timer tick, asking Buildbucket for the build status
[01:38:11.290] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:38:11.290] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:50:0) after 1m0s
[01:39:11.318] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:50:0)
[01:39:11.318] Timer tick, asking Buildbucket for the build status
[01:39:12.380] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:39:12.380] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:51:0) after 1m0s
[01:40:12.453] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:51:0)
[01:40:12.453] Timer tick, asking Buildbucket for the build status
[01:40:12.595] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:40:12.595] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:52:0) after 1m0s
[01:41:12.668] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:52:0)
[01:41:12.668] Timer tick, asking Buildbucket for the build status
[01:41:13.191] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:41:13.191] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:53:0) after 1m0s
[01:42:13.312] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:53:0)
[01:42:13.312] Timer tick, asking Buildbucket for the build status
[01:42:13.911] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:42:13.911] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:54:0) after 1m0s
[01:43:13.943] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:54:0)
[01:43:13.943] Timer tick, asking Buildbucket for the build status
[01:43:14.056] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:43:14.056] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:55:0) after 1m0s
[01:44:14.077] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:55:0)
[01:44:14.077] Timer tick, asking Buildbucket for the build status
[01:44:14.172] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:44:14.172] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:56:0) after 1m0s
[01:45:14.216] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:56:0)
[01:45:14.216] Timer tick, asking Buildbucket for the build status
[01:45:14.455] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:45:14.455] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:57:0) after 1m0s
[01:46:14.470] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:57:0)
[01:46:14.470] Timer tick, asking Buildbucket for the build status
[01:46:14.767] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:46:14.767] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:58:0) after 1m0s
[01:47:14.820] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:58:0)
[01:47:14.820] Timer tick, asking Buildbucket for the build status
[01:47:17.590] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:47:17.590] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:59:0) after 1m0s
[01:48:17.613] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:59:0)
[01:48:17.613] Timer tick, asking Buildbucket for the build status
[01:48:17.795] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:48:17.795] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:60:0) after 1m0s
[01:49:17.833] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:60:0)
[01:49:17.833] Timer tick, asking Buildbucket for the build status
[01:49:21.584] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:49:21.584] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:61:0) after 1m0s
[01:50:21.600] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:61:0)
[01:50:21.600] Timer tick, asking Buildbucket for the build status
[01:50:24.416] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:50:24.416] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:62:0) after 1m0s
[01:51:24.437] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:62:0)
[01:51:24.437] Timer tick, asking Buildbucket for the build status
[01:51:24.972] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:51:24.972] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:63:0) after 1m0s
[01:52:25.047] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:63:0)
[01:52:25.047] Timer tick, asking Buildbucket for the build status
[01:52:25.177] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:52:25.177] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:64:0) after 1m0s
[01:53:25.294] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:64:0)
[01:53:25.294] Timer tick, asking Buildbucket for the build status
[01:53:26.203] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:53:26.203] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:65:0) after 1m0s
[01:54:26.300] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:65:0)
[01:54:26.300] Timer tick, asking Buildbucket for the build status
[01:54:27.308] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:54:27.308] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:66:0) after 1m0s
[01:55:27.429] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:66:0)
[01:55:27.429] Timer tick, asking Buildbucket for the build status
[01:55:29.352] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:55:29.352] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:67:0) after 1m0s
[01:56:29.357] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:67:0)
[01:56:29.357] Timer tick, asking Buildbucket for the build status
[01:56:30.283] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:56:30.283] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:68:0) after 1m0s
[01:57:30.338] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:68:0)
[01:57:30.338] Timer tick, asking Buildbucket for the build status
[01:57:30.452] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:57:30.452] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:69:0) after 1m0s
[01:58:30.476] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:69:0)
[01:58:30.476] Timer tick, asking Buildbucket for the build status
[01:58:30.603] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:58:30.603] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:70:0) after 1m0s
[01:59:30.693] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:70:0)
[01:59:30.693] Timer tick, asking Buildbucket for the build status
[01:59:30.874] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[01:59:30.874] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:71:0) after 1m0s
[02:00:31.104] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:71:0)
[02:00:31.104] Timer tick, asking Buildbucket for the build status
[02:00:32.399] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:00:32.399] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:72:0) after 1m0s
[02:01:32.473] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:72:0)
[02:01:32.473] Timer tick, asking Buildbucket for the build status
[02:01:32.610] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:01:32.610] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:73:0) after 1m0s
[02:02:32.643] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:73:0)
[02:02:32.643] Timer tick, asking Buildbucket for the build status
[02:02:32.777] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:02:32.777] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:74:0) after 1m0s
[02:03:32.825] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:74:0)
[02:03:32.825] Timer tick, asking Buildbucket for the build status
[02:03:34.453] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:03:34.453] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:75:0) after 1m0s
[02:04:34.476] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:75:0)
[02:04:34.477] Timer tick, asking Buildbucket for the build status
[02:04:34.862] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:04:34.862] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:76:0) after 1m0s
[02:05:34.883] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:76:0)
[02:05:34.883] Timer tick, asking Buildbucket for the build status
[02:05:35.002] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:05:35.002] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:77:0) after 1m0s
[02:06:35.027] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:77:0)
[02:06:35.027] Timer tick, asking Buildbucket for the build status
[02:06:35.213] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:06:35.213] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:78:0) after 1m0s
[02:07:35.233] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:78:0)
[02:07:35.233] Timer tick, asking Buildbucket for the build status
[02:07:36.015] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:07:36.015] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:79:0) after 1m0s
[02:08:36.035] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:79:0)
[02:08:36.035] Timer tick, asking Buildbucket for the build status
[02:08:36.179] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:08:36.179] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:80:0) after 1m0s
[02:09:36.403] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:80:0)
[02:09:36.403] Timer tick, asking Buildbucket for the build status
[02:09:36.527] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:09:36.527] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:81:0) after 1m0s
[02:10:36.797] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:81:0)
[02:10:36.797] Timer tick, asking Buildbucket for the build status
[02:10:37.162] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:10:37.162] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:82:0) after 1m0s
[02:11:37.195] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:82:0)
[02:11:37.195] Timer tick, asking Buildbucket for the build status
[02:11:37.624] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:11:37.624] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:83:0) after 1m0s
[02:12:37.621] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:83:0)
[02:12:37.621] Timer tick, asking Buildbucket for the build status
[02:12:37.773] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:12:37.774] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:84:0) after 1m0s
[02:13:37.797] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:84:0)
[02:13:37.797] Timer tick, asking Buildbucket for the build status
[02:13:37.880] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:13:37.880] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:85:0) after 1m0s
[02:14:37.904] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:85:0)
[02:14:37.904] Timer tick, asking Buildbucket for the build status
[02:14:38.036] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:14:38.036] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:86:0) after 1m0s
[02:15:38.057] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:86:0)
[02:15:38.057] Timer tick, asking Buildbucket for the build status
[02:15:38.244] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:15:38.244] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:87:0) after 1m0s
[02:16:38.266] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:87:0)
[02:16:38.266] Timer tick, asking Buildbucket for the build status
[02:16:38.754] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:16:38.754] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:88:0) after 1m0s
[02:17:38.834] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:88:0)
[02:17:38.834] Timer tick, asking Buildbucket for the build status
[02:17:38.965] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:17:38.965] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:89:0) after 1m0s
[02:18:39.068] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:89:0)
[02:18:39.068] Timer tick, asking Buildbucket for the build status
[02:18:39.187] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:18:39.187] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:90:0) after 1m0s
[02:19:39.313] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:90:0)
[02:19:39.313] Timer tick, asking Buildbucket for the build status
[02:19:39.497] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:19:39.497] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:91:0) after 1m0s
[02:20:39.571] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:91:0)
[02:20:39.571] Timer tick, asking Buildbucket for the build status
[02:20:40.406] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:20:40.406] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:92:0) after 1m0s
[02:21:40.488] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:92:0)
[02:21:40.488] Timer tick, asking Buildbucket for the build status
[02:21:40.720] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:21:40.720] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:93:0) after 1m0s
[02:22:40.709] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:93:0)
[02:22:40.710] Timer tick, asking Buildbucket for the build status
[02:22:40.852] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:22:40.852] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:94:0) after 1m0s
[02:23:40.944] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:94:0)
[02:23:40.944] Timer tick, asking Buildbucket for the build status
[02:23:42.013] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:23:42.013] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:95:0) after 1m0s
[02:24:41.989] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:95:0)
[02:24:41.989] Timer tick, asking Buildbucket for the build status
[02:24:42.446] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:24:42.446] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:96:0) after 1m0s
[02:25:42.570] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:96:0)
[02:25:42.570] Timer tick, asking Buildbucket for the build status
[02:25:42.764] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:25:42.764] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:97:0) after 1m0s
[02:26:42.784] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:97:0)
[02:26:42.784] Timer tick, asking Buildbucket for the build status
[02:26:42.915] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:26:42.915] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:98:0) after 1m0s
[02:27:42.938] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:98:0)
[02:27:42.938] Timer tick, asking Buildbucket for the build status
[02:27:43.074] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:27:43.074] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:99:0) after 1m0s
[02:28:43.102] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:99:0)
[02:28:43.102] Timer tick, asking Buildbucket for the build status
[02:28:43.408] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:28:43.408] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:100:0) after 1m0s
[02:29:43.507] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:100:0)
[02:29:43.507] Timer tick, asking Buildbucket for the build status
[02:29:44.370] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:29:44.370] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:101:0) after 1m0s
[02:30:44.584] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:101:0)
[02:30:44.584] Timer tick, asking Buildbucket for the build status
[02:30:45.307] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:30:45.307] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:102:0) after 1m0s
[02:31:45.329] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:102:0)
[02:31:45.329] Timer tick, asking Buildbucket for the build status
[02:31:45.525] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:31:45.525] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:103:0) after 1m0s
[02:32:45.657] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:103:0)
[02:32:45.657] Timer tick, asking Buildbucket for the build status
[02:32:46.250] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:32:46.250] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:104:0) after 1m0s
[02:33:46.274] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:104:0)
[02:33:46.274] Timer tick, asking Buildbucket for the build status
[02:33:46.434] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:33:46.434] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:105:0) after 1m0s
[02:34:46.529] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:105:0)
[02:34:46.529] Timer tick, asking Buildbucket for the build status
[02:34:47.218] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:34:47.218] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:106:0) after 1m0s
[02:35:47.469] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:106:0)
[02:35:47.469] Timer tick, asking Buildbucket for the build status
[02:35:48.804] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:35:48.804] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:107:0) after 1m0s
[02:36:48.828] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:107:0)
[02:36:48.828] Timer tick, asking Buildbucket for the build status
[02:36:48.946] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:36:48.946] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:108:0) after 1m0s
[02:37:48.971] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:108:0)
[02:37:48.971] Timer tick, asking Buildbucket for the build status
[02:37:49.159] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:37:49.159] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:109:0) after 1m0s
[02:38:49.181] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:109:0)
[02:38:49.181] Timer tick, asking Buildbucket for the build status
[02:38:49.612] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:38:49.612] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:110:0) after 1m0s
[02:39:49.670] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:110:0)
[02:39:49.670] Timer tick, asking Buildbucket for the build status
[02:39:49.762] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:39:49.762] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:111:0) after 1m0s
[02:40:49.792] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:111:0)
[02:40:49.792] Timer tick, asking Buildbucket for the build status
[02:40:49.958] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:40:49.959] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:112:0) after 1m0s
[02:41:50.035] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:112:0)
[02:41:50.035] Timer tick, asking Buildbucket for the build status
[02:41:51.793] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:41:51.793] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:113:0) after 1m0s
[02:42:51.817] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:113:0)
[02:42:51.817] Timer tick, asking Buildbucket for the build status
[02:42:52.791] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:42:52.791] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:114:0) after 1m0s
[02:43:52.864] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:114:0)
[02:43:52.864] Timer tick, asking Buildbucket for the build status
[02:43:53.001] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:43:53.001] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:115:0) after 1m0s
[02:44:53.024] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:115:0)
[02:44:53.024] Timer tick, asking Buildbucket for the build status
[02:44:53.617] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:44:53.617] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:116:0) after 1m0s
[02:45:53.641] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:116:0)
[02:45:53.641] Timer tick, asking Buildbucket for the build status
[02:45:54.438] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:45:54.438] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:117:0) after 1m0s
[02:46:54.460] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:117:0)
[02:46:54.460] Timer tick, asking Buildbucket for the build status
[02:46:55.678] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:46:55.678] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:118:0) after 1m0s
[02:47:55.701] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:118:0)
[02:47:55.701] Timer tick, asking Buildbucket for the build status
[02:47:57.629] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:47:57.629] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:119:0) after 1m0s
[02:48:57.649] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:119:0)
[02:48:57.649] Timer tick, asking Buildbucket for the build status
[02:48:58.306] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:48:58.306] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:120:0) after 1m0s
[02:49:58.428] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:120:0)
[02:49:58.428] Timer tick, asking Buildbucket for the build status
[02:49:58.596] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:49:58.596] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:121:0) after 1m0s
[02:50:58.574] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:121:0)
[02:50:58.574] Timer tick, asking Buildbucket for the build status
[02:50:59.907] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:50:59.907] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:122:0) after 1m0s
[02:52:00.144] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:122:0)
[02:52:00.144] Timer tick, asking Buildbucket for the build status
[02:52:00.456] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:52:00.456] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:123:0) after 1m0s
[02:53:00.475] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:123:0)
[02:53:00.475] Timer tick, asking Buildbucket for the build status
[02:53:00.656] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:53:00.656] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:124:0) after 1m0s
[02:54:00.647] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:124:0)
[02:54:00.647] Timer tick, asking Buildbucket for the build status
[02:54:00.767] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:54:00.767] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:125:0) after 1m0s
[02:55:00.857] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:125:0)
[02:55:00.857] Timer tick, asking Buildbucket for the build status
[02:55:00.981] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:55:00.981] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:126:0) after 1m0s
[02:56:01.003] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:126:0)
[02:56:01.003] Timer tick, asking Buildbucket for the build status
[02:56:02.361] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:56:02.361] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:127:0) after 1m0s
[02:57:02.426] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:127:0)
[02:57:02.426] Timer tick, asking Buildbucket for the build status
[02:57:03.605] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:57:03.605] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:128:0) after 1m0s
[02:58:03.669] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:128:0)
[02:58:03.669] Timer tick, asking Buildbucket for the build status
[02:58:03.862] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:58:03.862] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:129:0) after 1m0s
[02:59:03.895] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:129:0)
[02:59:03.895] Timer tick, asking Buildbucket for the build status
[02:59:06.099] Build 8911081111382367840: status "STARTED", result "", failure_reason "", cancelation_reason ""
[02:59:06.099] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9076511174560669728:130:0) after 1m0s
[02:59:10.253] Received PubSub notification, asking Buildbucket for the build status
[02:59:10.919] Build 8911081111382367840: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[02:59:10.919] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1560135549505975",
"created_by": "project:chromium",
"created_ts": "1560127834869339",
"failure_reason": "BUILD_FAILURE",
"id": "8911081111382367840",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"60c3c6e0ea484417a9918723eab364038cee6c4e\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Failed ios_chrome_unittests (iPhone 6s iOS 11.4.1), ios_web_view_inttests (iPhone 6s iOS 11.4.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\": 12528, \"got_angle_revision\": \"2d0a9acb05511a8fdaf0cd27d0da22599516a68b\", \"got_dawn_revision\": \"7eb6be186be60a536a9f529b514bb5c5fd79293d\", \"got_nacl_revision\": \"c4cf6f0621b94cca4053b19fa01ef329f5663880\", \"got_revision\": \"60c3c6e0ea484417a9918723eab364038cee6c4e\", \"got_revision_cp\": \"refs/heads/master@{#667505}\", \"got_swarming_client_revision\": \"96f125709acfd0b48fc1e5dae7d6ea42291726ac\", \"got_v8_revision\": \"05e98a6eb753853cfbdabf257eba8cc633d5975f\", \"got_v8_revision_cp\": \"refs/heads/7.7.27@{#1}\", \"got_webrtc_revision\": \"54c9d89f69c50ae180e818528081404582a59a9c\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#28200}\", \"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\": \"60c3c6e0ea484417a9918723eab364038cee6c4e\", \"swarm_hashes\": {\"0\": \"c693b2ec7632e729ba90e52660ebc9019991f993\", \"1\": \"a6caa3357c2da20dd5d6330a1d48a041afac3d16\", \"10\": \"751e780f2c866875f18ac3ed96d331db810f04ca\", \"11\": \"e932ae2ad962aaf595f0a9b6762cf7eea1831199\", \"12\": \"d1f639043a28cc228ef8d52c0e9899dac84f9078\", \"13\": \"aa68129688eacac41edd578d70582fbc26b48921\", \"14\": \"db9beeb439121c5c599c99f0b6f34fef8b6e90be\", \"15\": \"bfdec6bab17d5ec22ad309a2e50a0ccef5049f7d\", \"16\": \"d17221d6a520d507aeeac8742d92869150c7b10a\", \"2\": \"9cd7138496a1756bc25f30d452f804bc03afc160\", \"3\": \"1984b68e7ba39431c04960f7a782538dab2c7989\", \"4\": \"cad9ff99e68851a514e2af05f323a662aaa187d0\", \"5\": \"7a1a79c9444d9fc8ecdcca026615f9485013ac1f\", \"6\": \"0e7bd70e107fa866f363d845a53386ead69f1624\", \"7\": \"e448e4860c398c5352b3926285b845045acfd551\", \"8\": \"d4533f79c6969fa1d8341e7af2ed707555a6fe1c\", \"9\": \"7f2c342012c0abff23087870186176a5aa9b91e7\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_4a4feefdd7e355061708c01720b06a0ca8c49ffc9968a2ebc674541738676b8f_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\": [\"4332-2f8e532\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}, \"ui\": {\"info\": \"Failed ios_chrome_unittests (iPhone 6s iOS 11.4.1), ios_web_view_inttests (iPhone 6s iOS 11.4.1).\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1560127970349136",
"status": "COMPLETED",
"status_changed_ts": "1560127970864470",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/12528",
"builder:ToTiOSDevice",
"buildset:commit/git/60c3c6e0ea484417a9918723eab364038cee6c4e",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/60c3c6e0ea484417a9918723eab364038cee6c4e",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9076511174560669728",
"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/8911081111382367840/+/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:4557af1909b27410",
"user_agent:luci-scheduler"
],
"updated_ts": "1560135549591518",
"url": "https://ci.chromium.org/b/8911081111382367840",
"utcnow_ts": "1560135550899208"
}
}
[02:59:10.919] Invocation finished in 2h8m38.463490418s with status FAILED