[09:24:52.193] New invocation is queued and will start shortly
[09:24:53.423] Starting the invocation (attempt 1)
[09:24:53.473] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[09:24:53.473] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[09:24:53.473] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9069321655456597952",
"parameters_json": "{\"builder_name\":\"ToTiOSDevice\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src.git\",\"revision\":\"449106cf197fac535172a11de63912ce91fe25b4\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:ToTiOSDevice",
"scheduler_invocation_id:9069321655456597952",
"scheduler_job_id:chromium/ToTiOSDevice",
"user_agent:luci-scheduler",
"buildset:commit/git/449106cf197fac535172a11de63912ce91fe25b4",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/449106cf197fac535172a11de63912ce91fe25b4",
"gitiles_ref:refs/heads/master"
]
}
[09:24:54.433] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1566984293800302",
"id": "8903891593102673536",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"449106cf197fac535172a11de63912ce91fe25b4\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1566984294256778",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/13860",
"builder:ToTiOSDevice",
"buildset:commit/git/449106cf197fac535172a11de63912ce91fe25b4",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/449106cf197fac535172a11de63912ce91fe25b4",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9069321655456597952",
"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/8903891593102673536/+/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": "1566984294256907",
"url": "https://ci.chromium.org/b/8903891593102673536",
"utcnow_ts": "1566984294418969"
}
}
[09:24:54.433] Task URL: https://ci.chromium.org/b/8903891593102673536
[09:24:54.433] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:2:0) after 1m0s
[09:25:15.514] Received PubSub notification, asking Buildbucket for the build status
[09:25:15.680] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:25:54.407] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:2:0)
[09:25:54.407] Timer tick, asking Buildbucket for the build status
[09:25:54.820] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:25:54.820] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:4:0) after 1m0s
[09:26:54.883] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:4:0)
[09:26:54.883] Timer tick, asking Buildbucket for the build status
[09:26:55.445] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:26:55.445] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:5:0) after 1m0s
[09:27:55.435] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:5:0)
[09:27:55.435] Timer tick, asking Buildbucket for the build status
[09:27:56.806] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:27:56.806] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:6:0) after 1m0s
[09:28:56.941] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:6:0)
[09:28:56.941] Timer tick, asking Buildbucket for the build status
[09:28:57.858] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:28:57.858] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:7:0) after 1m0s
[09:29:57.878] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:7:0)
[09:29:57.878] Timer tick, asking Buildbucket for the build status
[09:29:58.089] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:29:58.089] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:8:0) after 1m0s
[09:30:58.125] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:8:0)
[09:30:58.125] Timer tick, asking Buildbucket for the build status
[09:30:58.671] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:30:58.671] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:9:0) after 1m0s
[09:31:58.745] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:9:0)
[09:31:58.745] Timer tick, asking Buildbucket for the build status
[09:31:59.593] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:31:59.593] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:10:0) after 1m0s
[09:32:59.707] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:10:0)
[09:32:59.707] Timer tick, asking Buildbucket for the build status
[09:33:00.225] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:33:00.225] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:11:0) after 1m0s
[09:34:00.250] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:11:0)
[09:34:00.250] Timer tick, asking Buildbucket for the build status
[09:34:01.088] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:34:01.088] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:12:0) after 1m0s
[09:35:01.118] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:12:0)
[09:35:01.118] Timer tick, asking Buildbucket for the build status
[09:35:01.551] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:35:01.551] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:13:0) after 1m0s
[09:36:01.582] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:13:0)
[09:36:01.582] Timer tick, asking Buildbucket for the build status
[09:36:03.443] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:36:03.443] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:14:0) after 1m0s
[09:37:03.480] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:14:0)
[09:37:03.480] Timer tick, asking Buildbucket for the build status
[09:37:05.166] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:37:05.166] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:15:0) after 1m0s
[09:38:05.195] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:15:0)
[09:38:05.195] Timer tick, asking Buildbucket for the build status
[09:38:06.005] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:38:06.005] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:16:0) after 1m0s
[09:39:06.121] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:16:0)
[09:39:06.121] Timer tick, asking Buildbucket for the build status
[09:39:06.381] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:39:06.381] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:17:0) after 1m0s
[09:40:06.446] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:17:0)
[09:40:06.446] Timer tick, asking Buildbucket for the build status
[09:40:06.846] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:40:06.846] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:18:0) after 1m0s
[09:41:06.877] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:18:0)
[09:41:06.877] Timer tick, asking Buildbucket for the build status
[09:41:07.648] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:41:07.648] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:19:0) after 1m0s
[09:42:07.700] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:19:0)
[09:42:07.700] Timer tick, asking Buildbucket for the build status
[09:42:07.844] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:42:07.844] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:20:0) after 1m0s
[09:43:07.895] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:20:0)
[09:43:07.895] Timer tick, asking Buildbucket for the build status
[09:43:08.188] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:43:08.188] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:21:0) after 1m0s
[09:44:08.211] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:21:0)
[09:44:08.211] Timer tick, asking Buildbucket for the build status
[09:44:08.470] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:44:08.470] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:22:0) after 1m0s
[09:45:08.537] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:22:0)
[09:45:08.537] Timer tick, asking Buildbucket for the build status
[09:45:08.773] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:45:08.773] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:23:0) after 1m0s
[09:46:08.862] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:23:0)
[09:46:08.862] Timer tick, asking Buildbucket for the build status
[09:46:09.065] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:46:09.065] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:24:0) after 1m0s
[09:47:09.165] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:24:0)
[09:47:09.165] Timer tick, asking Buildbucket for the build status
[09:47:09.385] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:47:09.385] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:25:0) after 1m0s
[09:48:09.502] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:25:0)
[09:48:09.502] Timer tick, asking Buildbucket for the build status
[09:48:10.039] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:48:10.039] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:26:0) after 1m0s
[09:49:10.142] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:26:0)
[09:49:10.142] Timer tick, asking Buildbucket for the build status
[09:49:11.029] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:49:11.029] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:27:0) after 1m0s
[09:50:11.121] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:27:0)
[09:50:11.121] Timer tick, asking Buildbucket for the build status
[09:50:11.382] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:50:11.382] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:28:0) after 1m0s
[09:51:11.538] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:28:0)
[09:51:11.538] Timer tick, asking Buildbucket for the build status
[09:51:12.356] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:51:12.356] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:29:0) after 1m0s
[09:52:12.410] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:29:0)
[09:52:12.410] Timer tick, asking Buildbucket for the build status
[09:52:16.043] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:52:16.043] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:30:0) after 1m0s
[09:53:16.036] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:30:0)
[09:53:16.036] Timer tick, asking Buildbucket for the build status
[09:53:16.726] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:53:16.726] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:31:0) after 1m0s
[09:54:16.755] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:31:0)
[09:54:16.755] Timer tick, asking Buildbucket for the build status
[09:54:18.640] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:54:18.640] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:32:0) after 1m0s
[09:55:18.656] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:32:0)
[09:55:18.656] Timer tick, asking Buildbucket for the build status
[09:55:18.984] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:55:18.984] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:33:0) after 1m0s
[09:56:19.052] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:33:0)
[09:56:19.052] Timer tick, asking Buildbucket for the build status
[09:56:19.981] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:56:19.981] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:34:0) after 1m0s
[09:57:20.122] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:34:0)
[09:57:20.122] Timer tick, asking Buildbucket for the build status
[09:57:20.375] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:57:20.375] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:35:0) after 1m0s
[09:58:20.377] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:35:0)
[09:58:20.377] Timer tick, asking Buildbucket for the build status
[09:58:20.936] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:58:20.936] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:36:0) after 1m0s
[09:59:21.037] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:36:0)
[09:59:21.037] Timer tick, asking Buildbucket for the build status
[09:59:21.475] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:59:21.475] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:37:0) after 1m0s
[10:00:21.764] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:37:0)
[10:00:21.764] Timer tick, asking Buildbucket for the build status
[10:00:22.023] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:00:22.024] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:38:0) after 1m0s
[10:01:22.463] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:38:0)
[10:01:22.463] Timer tick, asking Buildbucket for the build status
[10:01:22.862] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:01:22.862] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:39:0) after 1m0s
[10:02:23.147] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:39:0)
[10:02:23.147] Timer tick, asking Buildbucket for the build status
[10:02:23.870] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:02:23.871] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:40:0) after 1m0s
[10:03:23.993] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:40:0)
[10:03:23.993] Timer tick, asking Buildbucket for the build status
[10:03:26.831] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:03:26.831] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:41:0) after 1m0s
[10:04:26.922] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:41:0)
[10:04:26.922] Timer tick, asking Buildbucket for the build status
[10:04:27.251] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:04:27.251] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:42:0) after 1m0s
[10:05:27.242] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:42:0)
[10:05:27.242] Timer tick, asking Buildbucket for the build status
[10:05:27.496] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:05:27.496] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:43:0) after 1m0s
[10:06:27.606] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:43:0)
[10:06:27.606] Timer tick, asking Buildbucket for the build status
[10:06:28.061] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:06:28.061] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:44:0) after 1m0s
[10:07:28.081] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:44:0)
[10:07:28.081] Timer tick, asking Buildbucket for the build status
[10:07:28.434] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:07:28.434] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:45:0) after 1m0s
[10:08:28.460] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:45:0)
[10:08:28.460] Timer tick, asking Buildbucket for the build status
[10:08:29.123] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:08:29.123] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:46:0) after 1m0s
[10:09:29.131] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:46:0)
[10:09:29.131] Timer tick, asking Buildbucket for the build status
[10:09:29.884] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:09:29.884] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:47:0) after 1m0s
[10:10:29.911] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:47:0)
[10:10:29.911] Timer tick, asking Buildbucket for the build status
[10:10:30.544] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:10:30.544] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:48:0) after 1m0s
[10:11:30.623] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:48:0)
[10:11:30.623] Timer tick, asking Buildbucket for the build status
[10:11:31.182] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:11:31.182] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:49:0) after 1m0s
[10:12:31.155] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:49:0)
[10:12:31.155] Timer tick, asking Buildbucket for the build status
[10:12:31.510] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:12:31.510] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:50:0) after 1m0s
[10:13:31.536] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:50:0)
[10:13:31.536] Timer tick, asking Buildbucket for the build status
[10:13:32.171] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:13:32.171] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:51:0) after 1m0s
[10:14:32.276] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:51:0)
[10:14:32.276] Timer tick, asking Buildbucket for the build status
[10:14:32.448] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:14:32.448] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:52:0) after 1m0s
[10:15:32.575] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:52:0)
[10:15:32.575] Timer tick, asking Buildbucket for the build status
[10:15:33.194] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:15:33.194] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:53:0) after 1m0s
[10:16:33.393] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:53:0)
[10:16:33.393] Timer tick, asking Buildbucket for the build status
[10:16:33.656] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:16:33.656] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:54:0) after 1m0s
[10:17:33.697] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:54:0)
[10:17:33.697] Timer tick, asking Buildbucket for the build status
[10:17:34.337] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:17:34.337] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:55:0) after 1m0s
[10:18:34.363] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:55:0)
[10:18:34.363] Timer tick, asking Buildbucket for the build status
[10:18:34.736] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:18:34.736] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:56:0) after 1m0s
[10:19:34.765] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:56:0)
[10:19:34.765] Timer tick, asking Buildbucket for the build status
[10:19:34.949] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:19:34.949] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:57:0) after 1m0s
[10:20:35.008] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:57:0)
[10:20:35.008] Timer tick, asking Buildbucket for the build status
[10:20:35.207] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:20:35.207] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:58:0) after 1m0s
[10:21:35.277] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:58:0)
[10:21:35.277] Timer tick, asking Buildbucket for the build status
[10:21:35.985] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:21:35.985] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:59:0) after 1m0s
[10:22:36.069] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:59:0)
[10:22:36.069] Timer tick, asking Buildbucket for the build status
[10:22:36.460] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:22:36.460] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:60:0) after 1m0s
[10:23:36.554] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:60:0)
[10:23:36.554] Timer tick, asking Buildbucket for the build status
[10:23:36.991] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:23:36.991] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:61:0) after 1m0s
[10:24:37.151] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:61:0)
[10:24:37.151] Timer tick, asking Buildbucket for the build status
[10:24:37.501] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:24:37.501] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:62:0) after 1m0s
[10:25:37.622] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:62:0)
[10:25:37.622] Timer tick, asking Buildbucket for the build status
[10:25:37.852] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:25:37.852] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:63:0) after 1m0s
[10:26:37.862] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:63:0)
[10:26:37.862] Timer tick, asking Buildbucket for the build status
[10:26:38.603] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:26:38.603] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:64:0) after 1m0s
[10:27:38.685] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:64:0)
[10:27:38.685] Timer tick, asking Buildbucket for the build status
[10:27:40.740] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:27:40.741] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:65:0) after 1m0s
[10:28:40.771] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:65:0)
[10:28:40.771] Timer tick, asking Buildbucket for the build status
[10:28:41.443] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:28:41.443] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:66:0) after 1m0s
[10:29:41.540] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:66:0)
[10:29:41.540] Timer tick, asking Buildbucket for the build status
[10:29:41.917] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:29:41.917] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:67:0) after 1m0s
[10:30:41.945] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:67:0)
[10:30:41.945] Timer tick, asking Buildbucket for the build status
[10:30:42.201] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:30:42.201] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:68:0) after 1m0s
[10:31:42.230] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:68:0)
[10:31:42.230] Timer tick, asking Buildbucket for the build status
[10:31:42.388] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:31:42.388] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:69:0) after 1m0s
[10:32:42.420] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:69:0)
[10:32:42.420] Timer tick, asking Buildbucket for the build status
[10:32:42.782] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:32:42.782] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:70:0) after 1m0s
[10:33:42.833] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:70:0)
[10:33:42.833] Timer tick, asking Buildbucket for the build status
[10:33:43.095] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:33:43.095] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:71:0) after 1m0s
[10:34:43.140] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:71:0)
[10:34:43.140] Timer tick, asking Buildbucket for the build status
[10:34:43.782] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:34:43.782] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:72:0) after 1m0s
[10:35:43.795] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:72:0)
[10:35:43.795] Timer tick, asking Buildbucket for the build status
[10:35:44.303] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:35:44.303] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:73:0) after 1m0s
[10:36:44.377] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:73:0)
[10:36:44.377] Timer tick, asking Buildbucket for the build status
[10:36:45.184] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:36:45.184] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:74:0) after 1m0s
[10:37:45.232] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:74:0)
[10:37:45.232] Timer tick, asking Buildbucket for the build status
[10:37:45.670] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:37:45.670] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:75:0) after 1m0s
[10:38:45.695] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:75:0)
[10:38:45.695] Timer tick, asking Buildbucket for the build status
[10:38:46.512] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:38:46.512] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:76:0) after 1m0s
[10:39:46.569] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:76:0)
[10:39:46.569] Timer tick, asking Buildbucket for the build status
[10:39:46.783] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:39:46.783] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:77:0) after 1m0s
[10:40:46.820] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:77:0)
[10:40:46.820] Timer tick, asking Buildbucket for the build status
[10:40:47.053] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:40:47.053] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:78:0) after 1m0s
[10:41:47.094] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:78:0)
[10:41:47.094] Timer tick, asking Buildbucket for the build status
[10:41:47.354] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:41:47.354] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:79:0) after 1m0s
[10:42:47.351] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:79:0)
[10:42:47.351] Timer tick, asking Buildbucket for the build status
[10:42:47.812] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:42:47.812] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:80:0) after 1m0s
[10:43:47.839] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:80:0)
[10:43:47.839] Timer tick, asking Buildbucket for the build status
[10:43:48.023] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:43:48.023] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:81:0) after 1m0s
[10:44:48.081] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:81:0)
[10:44:48.081] Timer tick, asking Buildbucket for the build status
[10:44:48.546] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:44:48.546] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:82:0) after 1m0s
[10:45:48.574] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:82:0)
[10:45:48.574] Timer tick, asking Buildbucket for the build status
[10:45:49.442] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:45:49.442] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:83:0) after 1m0s
[10:46:49.479] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:83:0)
[10:46:49.479] Timer tick, asking Buildbucket for the build status
[10:46:49.662] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:46:49.662] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:84:0) after 1m0s
[10:47:49.703] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:84:0)
[10:47:49.703] Timer tick, asking Buildbucket for the build status
[10:47:50.524] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:47:50.524] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:85:0) after 1m0s
[10:48:50.562] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:85:0)
[10:48:50.562] Timer tick, asking Buildbucket for the build status
[10:48:51.232] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:48:51.232] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:86:0) after 1m0s
[10:49:51.329] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:86:0)
[10:49:51.329] Timer tick, asking Buildbucket for the build status
[10:49:53.193] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:49:53.193] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:87:0) after 1m0s
[10:50:53.187] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:87:0)
[10:50:53.187] Timer tick, asking Buildbucket for the build status
[10:50:53.363] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:50:53.363] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:88:0) after 1m0s
[10:51:53.418] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:88:0)
[10:51:53.418] Timer tick, asking Buildbucket for the build status
[10:51:54.872] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:51:54.872] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:89:0) after 1m0s
[10:52:54.964] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:89:0)
[10:52:54.964] Timer tick, asking Buildbucket for the build status
[10:52:55.473] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:52:55.473] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:90:0) after 1m0s
[10:53:55.531] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:90:0)
[10:53:55.531] Timer tick, asking Buildbucket for the build status
[10:53:55.722] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:53:55.722] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:91:0) after 1m0s
[10:54:55.773] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:91:0)
[10:54:55.773] Timer tick, asking Buildbucket for the build status
[10:54:56.052] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:54:56.052] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:92:0) after 1m0s
[10:55:56.083] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:92:0)
[10:55:56.083] Timer tick, asking Buildbucket for the build status
[10:55:56.305] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:55:56.305] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:93:0) after 1m0s
[10:56:56.349] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:93:0)
[10:56:56.349] Timer tick, asking Buildbucket for the build status
[10:56:56.663] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:56:56.663] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:94:0) after 1m0s
[10:57:56.688] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:94:0)
[10:57:56.688] Timer tick, asking Buildbucket for the build status
[10:57:56.861] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:57:56.861] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:95:0) after 1m0s
[10:58:56.897] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:95:0)
[10:58:56.897] Timer tick, asking Buildbucket for the build status
[10:58:57.106] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:58:57.106] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:96:0) after 1m0s
[10:59:57.143] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:96:0)
[10:59:57.143] Timer tick, asking Buildbucket for the build status
[10:59:57.337] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:59:57.337] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:97:0) after 1m0s
[11:00:57.817] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:97:0)
[11:00:57.817] Timer tick, asking Buildbucket for the build status
[11:01:00.586] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:01:00.586] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:98:0) after 1m0s
[11:02:00.870] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:98:0)
[11:02:00.870] Timer tick, asking Buildbucket for the build status
[11:02:01.601] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:02:01.601] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:99:0) after 1m0s
[11:03:01.691] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:99:0)
[11:03:01.691] Timer tick, asking Buildbucket for the build status
[11:03:01.963] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:03:01.963] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:100:0) after 1m0s
[11:04:01.970] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:100:0)
[11:04:01.970] Timer tick, asking Buildbucket for the build status
[11:04:04.567] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:04:04.567] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:101:0) after 1m0s
[11:05:04.638] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:101:0)
[11:05:04.638] Timer tick, asking Buildbucket for the build status
[11:05:05.312] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:05:05.312] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:102:0) after 1m0s
[11:06:05.328] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:102:0)
[11:06:05.328] Timer tick, asking Buildbucket for the build status
[11:06:05.546] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:06:05.546] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:103:0) after 1m0s
[11:07:05.641] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:103:0)
[11:07:05.641] Timer tick, asking Buildbucket for the build status
[11:07:05.970] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:07:05.970] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:104:0) after 1m0s
[11:08:06.047] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:104:0)
[11:08:06.047] Timer tick, asking Buildbucket for the build status
[11:08:06.246] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:08:06.246] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:105:0) after 1m0s
[11:09:06.375] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:105:0)
[11:09:06.375] Timer tick, asking Buildbucket for the build status
[11:09:06.894] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:09:06.894] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:106:0) after 1m0s
[11:10:06.921] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:106:0)
[11:10:06.921] Timer tick, asking Buildbucket for the build status
[11:10:07.306] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:10:07.306] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:107:0) after 1m0s
[11:11:07.330] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:107:0)
[11:11:07.330] Timer tick, asking Buildbucket for the build status
[11:11:07.586] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:11:07.586] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:108:0) after 1m0s
[11:12:07.665] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:108:0)
[11:12:07.665] Timer tick, asking Buildbucket for the build status
[11:12:08.361] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:12:08.361] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:109:0) after 1m0s
[11:13:08.446] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:109:0)
[11:13:08.446] Timer tick, asking Buildbucket for the build status
[11:13:09.004] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:13:09.004] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:110:0) after 1m0s
[11:14:09.051] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:110:0)
[11:14:09.051] Timer tick, asking Buildbucket for the build status
[11:14:09.371] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:14:09.371] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:111:0) after 1m0s
[11:15:09.421] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:111:0)
[11:15:09.421] Timer tick, asking Buildbucket for the build status
[11:15:10.323] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:15:10.323] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:112:0) after 1m0s
[11:16:10.334] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:112:0)
[11:16:10.334] Timer tick, asking Buildbucket for the build status
[11:16:13.406] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:16:13.406] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:113:0) after 1m0s
[11:17:13.478] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:113:0)
[11:17:13.478] Timer tick, asking Buildbucket for the build status
[11:17:13.628] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:17:13.628] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:114:0) after 1m0s
[11:18:13.747] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:114:0)
[11:18:13.747] Timer tick, asking Buildbucket for the build status
[11:18:14.218] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:18:14.218] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:115:0) after 1m0s
[11:19:14.243] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:115:0)
[11:19:14.243] Timer tick, asking Buildbucket for the build status
[11:19:14.481] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:19:14.481] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:116:0) after 1m0s
[11:20:14.620] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:116:0)
[11:20:14.620] Timer tick, asking Buildbucket for the build status
[11:20:14.794] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:20:14.794] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:117:0) after 1m0s
[11:21:14.852] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:117:0)
[11:21:14.852] Timer tick, asking Buildbucket for the build status
[11:21:15.064] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:21:15.064] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:118:0) after 1m0s
[11:22:15.092] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:118:0)
[11:22:15.092] Timer tick, asking Buildbucket for the build status
[11:22:15.781] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:22:15.781] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:119:0) after 1m0s
[11:23:15.791] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:119:0)
[11:23:15.791] Timer tick, asking Buildbucket for the build status
[11:23:16.293] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:23:16.293] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:120:0) after 1m0s
[11:24:16.322] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:120:0)
[11:24:16.322] Timer tick, asking Buildbucket for the build status
[11:24:16.558] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:24:16.558] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:121:0) after 1m0s
[11:25:16.645] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:121:0)
[11:25:16.645] Timer tick, asking Buildbucket for the build status
[11:25:16.854] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:25:16.854] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:122:0) after 1m0s
[11:26:16.910] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:122:0)
[11:26:16.910] Timer tick, asking Buildbucket for the build status
[11:26:17.114] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:26:17.114] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:123:0) after 1m0s
[11:27:17.184] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:123:0)
[11:27:17.184] Timer tick, asking Buildbucket for the build status
[11:27:17.703] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:27:17.703] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:124:0) after 1m0s
[11:28:17.869] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:124:0)
[11:28:17.869] Timer tick, asking Buildbucket for the build status
[11:28:18.071] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:28:18.071] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:125:0) after 1m0s
[11:29:18.114] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:125:0)
[11:29:18.114] Timer tick, asking Buildbucket for the build status
[11:29:18.558] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:29:18.558] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:126:0) after 1m0s
[11:30:18.623] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:126:0)
[11:30:18.623] Timer tick, asking Buildbucket for the build status
[11:30:19.306] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:30:19.306] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:127:0) after 1m0s
[11:31:19.343] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:127:0)
[11:31:19.343] Timer tick, asking Buildbucket for the build status
[11:31:22.045] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:31:22.045] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:128:0) after 1m0s
[11:32:22.136] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:128:0)
[11:32:22.136] Timer tick, asking Buildbucket for the build status
[11:32:22.515] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:32:22.515] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:129:0) after 1m0s
[11:33:22.570] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:129:0)
[11:33:22.570] Timer tick, asking Buildbucket for the build status
[11:33:23.205] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:33:23.205] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:130:0) after 1m0s
[11:34:23.242] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:130:0)
[11:34:23.242] Timer tick, asking Buildbucket for the build status
[11:34:23.570] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:34:23.570] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:131:0) after 1m0s
[11:35:23.556] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:131:0)
[11:35:23.556] Timer tick, asking Buildbucket for the build status
[11:35:24.227] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:35:24.227] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:132:0) after 1m0s
[11:36:24.285] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:132:0)
[11:36:24.285] Timer tick, asking Buildbucket for the build status
[11:36:24.483] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:36:24.483] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:133:0) after 1m0s
[11:37:24.528] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:133:0)
[11:37:24.528] Timer tick, asking Buildbucket for the build status
[11:37:24.951] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:37:24.951] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:134:0) after 1m0s
[11:38:24.989] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:134:0)
[11:38:24.989] Timer tick, asking Buildbucket for the build status
[11:38:25.232] Build 8903891593102673536: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:38:25.232] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9069321655456597952:135:0) after 1m0s
[11:38:52.229] Received PubSub notification, asking Buildbucket for the build status
[11:38:52.360] Build 8903891593102673536: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[11:38:52.360] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1566992328914625",
"created_by": "project:chromium",
"created_ts": "1566984293800302",
"failure_reason": "BUILD_FAILURE",
"id": "8903891593102673536",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src.git\", \"revision\": \"449106cf197fac535172a11de63912ce91fe25b4\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Failed ios_web_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\": \"build285-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"ToTiOSDevice\", \"buildnumber\": 13860, \"got_angle_revision\": \"886698bc3fddf45fb1e1987b1fa0e2d506eb52a8\", \"got_dawn_revision\": \"7ffd2346f8fad7d63091ea278d36e3f28177167b\", \"got_nacl_revision\": \"058a26f57015051953a727add26e7e26348b9558\", \"got_revision\": \"449106cf197fac535172a11de63912ce91fe25b4\", \"got_revision_cp\": \"refs/heads/master@{#691085}\", \"got_swarming_client_revision\": \"96f125709acfd0b48fc1e5dae7d6ea42291726ac\", \"got_v8_revision\": \"d190ff4eb6834bb09fb07be991337a862b2968e7\", \"got_v8_revision_cp\": \"refs/heads/7.8.207@{#1}\", \"got_webrtc_revision\": \"2d5aec56fdf7ff61166bb5fd3c67d4bcb81b0d5a\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#28975}\", \"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\": \"449106cf197fac535172a11de63912ce91fe25b4\", \"swarm_hashes\": {\"0\": \"83a456e58504d5ea07a6451edf7f531749cae94c\", \"1\": \"504ac37ec5edcb21241155287edf620584f1205d\", \"10\": \"d1ecf0a0a480aef2d8ef4926f836be0060767683\", \"11\": \"f9d55d0aad2136186e9a512200dd19e56d1d5252\", \"12\": \"cbc25209a98b7665b30b04f954edc836896dca7c\", \"13\": \"510c4add75fb2c517cb4ad945cafa9f4f516614e\", \"14\": \"8b5f1b000385bb607f9c2c3995f7ae81e372ce14\", \"15\": \"f4c7c53f50299814802d000dd88ad46aaf00a326\", \"16\": \"8f683c9de99b01ad4d04644768f112c43cbac38f\", \"2\": \"5aa211304dfd635a4befffdeecf2ee634b66a7db\", \"3\": \"87fdf1e5da1f1180de29d0df7afd0d4eda3e0baa\", \"4\": \"0446579b2f2e504dfbb60b3e1d0ae65fecd09a3f\", \"5\": \"fb7f32f5b80ef90d40843ecb712f5f89155c114b\", \"6\": \"d700af5d502d2cb96b9327093852ccfdb66645c0\", \"7\": \"30b467ae914680ee6b4c21dfbe7defb209a0830a\", \"8\": \"377f6eac6638260f5de856d7e03a5f96b71bbb54\", \"9\": \"01e2e7d2bd41f6969d4f1be775dc3f8c2bf5069a\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_4a4feefdd7e355061708c01720b06a0ca8c49ffc9968a2ebc674541738676b8f_v2\", \"builder_69caa34b8f39daac28a821cac2619730401d46a6479812cc34796e3bf180418a_v2\", \"builder_ae5debd901c74ee0906916cb62621bceb2a8b657b42c2e2e9e89a0f6a2e5e53b_v2\", \"builder_d42b89eab403033f5a2a8102ec9c436397350cedb439d5e09b11874a5784adb4_v2\", \"git\", \"goma_v2\", \"vpython\", \"xcode_ios_11m382q\", \"xcode_ios_11m392q\"], \"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\": [\"build285-m9\"], \"mac_model\": [\"MacPro6,1\"], \"machine_type\": [\"n1-standard-16\"], \"os\": [\"Mac\", \"Mac-10.14\", \"Mac-10.14.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.10\"], \"server_version\": [\"4397-8786906\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}, \"ui\": {\"info\": \"Failed ios_web_unittests (iPhone 6s iOS 12.3.1).\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1566984311973203",
"status": "COMPLETED",
"status_changed_ts": "1566984313057277",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/13860",
"builder:ToTiOSDevice",
"buildset:commit/git/449106cf197fac535172a11de63912ce91fe25b4",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/449106cf197fac535172a11de63912ce91fe25b4",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9069321655456597952",
"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/8903891593102673536/+/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:46f05c5a902f9810",
"user_agent:luci-scheduler"
],
"updated_ts": "1566992329670691",
"url": "https://ci.chromium.org/b/8903891593102673536",
"utcnow_ts": "1566992332348537"
}
}
[11:38:52.360] Invocation finished in 2h14m0.187837653s with status FAILED