[10:14:34.393] New invocation is queued and will start shortly
[10:14:35.599] Starting the invocation (attempt 1)
[10:14:35.635] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:14:35.635] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:14:35.636] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9055728983429946416",
"parameters_json": "{\"builder_name\":\"ToTiOSDevice\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"f0aca2de536ceecd6eb66e928051d11e6d11991f\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:ToTiOSDevice",
"scheduler_invocation_id:9055728983429946416",
"scheduler_job_id:chromium/ToTiOSDevice",
"user_agent:luci-scheduler",
"buildset:commit/git/f0aca2de536ceecd6eb66e928051d11e6d11991f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/f0aca2de536ceecd6eb66e928051d11e6d11991f",
"gitiles_ref:refs/heads/master"
]
}
[10:14:36.573] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"created_by": "project:chromium",
"created_ts": "1579947275862768",
"id": "8890298921223846688",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"f0aca2de536ceecd6eb66e928051d11e6d11991f\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1579947276421048",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/16151",
"builder:ToTiOSDevice",
"buildset:commit/git/f0aca2de536ceecd6eb66e928051d11e6d11991f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/f0aca2de536ceecd6eb66e928051d11e6d11991f",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9055728983429946416",
"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/8890298921223846688/+/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": "1579947276421178",
"url": "https://ci.chromium.org/b/8890298921223846688",
"utcnow_ts": "1579947276565082"
}
}
[10:14:36.573] Task URL: https://ci.chromium.org/b/8890298921223846688
[10:14:36.573] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:2:0) after 1m0s
[10:15:36.748] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:2:0)
[10:15:36.748] Timer tick, asking Buildbucket for the build status
[10:15:37.105] Build 8890298921223846688: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:15:37.105] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:3:0) after 1m0s
[10:16:37.187] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:3:0)
[10:16:37.187] Timer tick, asking Buildbucket for the build status
[10:16:37.333] Build 8890298921223846688: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[10:16:37.333] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:4:0) after 1m0s
[10:17:09.193] Received PubSub notification, asking Buildbucket for the build status
[10:17:09.327] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:17:37.407] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:4:0)
[10:17:37.407] Timer tick, asking Buildbucket for the build status
[10:17:37.634] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:17:37.634] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:6:0) after 1m0s
[10:18:37.623] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:6:0)
[10:18:37.623] Timer tick, asking Buildbucket for the build status
[10:18:38.570] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:18:38.570] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:7:0) after 1m0s
[10:19:38.624] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:7:0)
[10:19:38.624] Timer tick, asking Buildbucket for the build status
[10:19:39.158] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:19:39.158] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:8:0) after 1m0s
[10:20:39.914] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:8:0)
[10:20:39.914] Timer tick, asking Buildbucket for the build status
[10:20:40.127] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:20:40.127] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:9:0) after 1m0s
[10:21:40.484] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:9:0)
[10:21:40.484] Timer tick, asking Buildbucket for the build status
[10:21:40.667] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:21:40.667] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:10:0) after 1m0s
[10:22:40.854] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:10:0)
[10:22:40.854] Timer tick, asking Buildbucket for the build status
[10:22:41.098] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:22:41.098] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:11:0) after 1m0s
[10:23:41.508] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:11:0)
[10:23:41.508] Timer tick, asking Buildbucket for the build status
[10:23:41.711] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:23:41.711] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:12:0) after 1m0s
[10:24:41.973] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:12:0)
[10:24:41.973] Timer tick, asking Buildbucket for the build status
[10:24:42.487] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:24:42.487] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:13:0) after 1m0s
[10:25:42.601] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:13:0)
[10:25:42.601] Timer tick, asking Buildbucket for the build status
[10:25:42.813] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:25:42.813] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:14:0) after 1m0s
[10:26:43.253] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:14:0)
[10:26:43.253] Timer tick, asking Buildbucket for the build status
[10:26:43.426] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:26:43.426] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:15:0) after 1m0s
[10:27:43.459] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:15:0)
[10:27:43.459] Timer tick, asking Buildbucket for the build status
[10:27:43.611] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:27:43.611] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:16:0) after 1m0s
[10:28:43.735] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:16:0)
[10:28:43.735] Timer tick, asking Buildbucket for the build status
[10:28:44.366] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:28:44.366] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:17:0) after 1m0s
[10:29:44.744] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:17:0)
[10:29:44.744] Timer tick, asking Buildbucket for the build status
[10:29:44.914] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:29:44.914] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:18:0) after 1m0s
[10:30:45.046] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:18:0)
[10:30:45.046] Timer tick, asking Buildbucket for the build status
[10:30:45.994] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:30:45.994] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:19:0) after 1m0s
[10:31:46.274] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:19:0)
[10:31:46.274] Timer tick, asking Buildbucket for the build status
[10:31:46.476] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:31:46.476] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:20:0) after 1m0s
[10:32:46.597] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:20:0)
[10:32:46.597] Timer tick, asking Buildbucket for the build status
[10:32:46.807] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:32:46.807] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:21:0) after 1m0s
[10:33:47.079] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:21:0)
[10:33:47.079] Timer tick, asking Buildbucket for the build status
[10:33:47.782] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:33:47.782] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:22:0) after 1m0s
[10:34:48.004] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:22:0)
[10:34:48.004] Timer tick, asking Buildbucket for the build status
[10:34:48.169] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:34:48.169] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:23:0) after 1m0s
[10:35:48.456] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:23:0)
[10:35:48.456] Timer tick, asking Buildbucket for the build status
[10:35:48.892] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:35:48.892] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:24:0) after 1m0s
[10:36:49.248] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:24:0)
[10:36:49.248] Timer tick, asking Buildbucket for the build status
[10:36:49.457] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:36:49.457] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:25:0) after 1m0s
[10:37:49.655] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:25:0)
[10:37:49.655] Timer tick, asking Buildbucket for the build status
[10:37:49.830] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:37:49.830] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:26:0) after 1m0s
[10:38:49.964] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:26:0)
[10:38:49.964] Timer tick, asking Buildbucket for the build status
[10:38:50.133] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:38:50.133] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:27:0) after 1m0s
[10:39:50.251] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:27:0)
[10:39:50.251] Timer tick, asking Buildbucket for the build status
[10:39:50.855] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:39:50.855] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:28:0) after 1m0s
[10:40:50.951] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:28:0)
[10:40:50.951] Timer tick, asking Buildbucket for the build status
[10:40:51.141] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:40:51.141] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:29:0) after 1m0s
[10:41:51.160] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:29:0)
[10:41:51.160] Timer tick, asking Buildbucket for the build status
[10:41:51.361] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:41:51.361] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:30:0) after 1m0s
[10:42:51.427] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:30:0)
[10:42:51.427] Timer tick, asking Buildbucket for the build status
[10:42:51.771] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:42:51.771] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:31:0) after 1m0s
[10:43:51.794] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:31:0)
[10:43:51.794] Timer tick, asking Buildbucket for the build status
[10:43:52.365] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:43:52.365] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:32:0) after 1m0s
[10:44:52.387] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:32:0)
[10:44:52.387] Timer tick, asking Buildbucket for the build status
[10:44:52.523] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:44:52.523] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:33:0) after 1m0s
[10:45:52.612] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:33:0)
[10:45:52.612] Timer tick, asking Buildbucket for the build status
[10:45:52.754] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:45:52.754] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:34:0) after 1m0s
[10:46:52.904] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:34:0)
[10:46:52.904] Timer tick, asking Buildbucket for the build status
[10:46:53.091] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:46:53.091] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:35:0) after 1m0s
[10:47:53.119] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:35:0)
[10:47:53.119] Timer tick, asking Buildbucket for the build status
[10:47:53.334] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:47:53.334] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:36:0) after 1m0s
[10:48:53.355] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:36:0)
[10:48:53.355] Timer tick, asking Buildbucket for the build status
[10:48:54.061] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:48:54.061] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:37:0) after 1m0s
[10:49:54.085] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:37:0)
[10:49:54.085] Timer tick, asking Buildbucket for the build status
[10:49:54.254] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:49:54.254] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:38:0) after 1m0s
[10:50:54.455] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:38:0)
[10:50:54.455] Timer tick, asking Buildbucket for the build status
[10:50:55.574] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:50:55.574] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:39:0) after 1m0s
[10:51:55.594] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:39:0)
[10:51:55.594] Timer tick, asking Buildbucket for the build status
[10:51:55.733] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:51:55.733] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:40:0) after 1m0s
[10:52:55.839] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:40:0)
[10:52:55.839] Timer tick, asking Buildbucket for the build status
[10:52:55.963] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:52:55.963] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:41:0) after 1m0s
[10:53:57.079] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:41:0)
[10:53:57.079] Timer tick, asking Buildbucket for the build status
[10:53:57.486] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:53:57.486] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:42:0) after 1m0s
[10:54:57.511] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:42:0)
[10:54:57.511] Timer tick, asking Buildbucket for the build status
[10:54:57.691] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:54:57.691] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:43:0) after 1m0s
[10:55:57.825] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:43:0)
[10:55:57.825] Timer tick, asking Buildbucket for the build status
[10:55:58.026] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:55:58.026] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:44:0) after 1m0s
[10:56:58.046] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:44:0)
[10:56:58.046] Timer tick, asking Buildbucket for the build status
[10:56:58.711] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:56:58.711] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:45:0) after 1m0s
[10:57:58.879] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:45:0)
[10:57:58.879] Timer tick, asking Buildbucket for the build status
[10:57:59.253] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:57:59.253] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:46:0) after 1m0s
[10:58:59.329] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:46:0)
[10:58:59.329] Timer tick, asking Buildbucket for the build status
[10:58:59.491] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:58:59.491] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:47:0) after 1m0s
[10:59:59.531] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:47:0)
[10:59:59.531] Timer tick, asking Buildbucket for the build status
[10:59:59.871] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:59:59.871] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:48:0) after 1m0s
[11:00:59.898] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:48:0)
[11:00:59.898] Timer tick, asking Buildbucket for the build status
[11:01:00.279] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:01:00.279] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:49:0) after 1m0s
[11:02:00.409] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:49:0)
[11:02:00.409] Timer tick, asking Buildbucket for the build status
[11:02:00.595] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:02:00.595] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:50:0) after 1m0s
[11:03:00.619] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:50:0)
[11:03:00.619] Timer tick, asking Buildbucket for the build status
[11:03:00.820] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:03:00.820] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:51:0) after 1m0s
[11:04:00.862] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:51:0)
[11:04:00.863] Timer tick, asking Buildbucket for the build status
[11:04:00.995] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:04:00.995] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:52:0) after 1m0s
[11:05:01.014] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:52:0)
[11:05:01.014] Timer tick, asking Buildbucket for the build status
[11:05:01.724] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:05:01.724] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:53:0) after 1m0s
[11:06:01.744] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:53:0)
[11:06:01.744] Timer tick, asking Buildbucket for the build status
[11:06:02.167] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:06:02.167] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:54:0) after 1m0s
[11:07:02.196] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:54:0)
[11:07:02.196] Timer tick, asking Buildbucket for the build status
[11:07:02.528] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:07:02.528] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:55:0) after 1m0s
[11:08:02.547] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:55:0)
[11:08:02.547] Timer tick, asking Buildbucket for the build status
[11:08:02.874] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:08:02.874] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:56:0) after 1m0s
[11:09:02.992] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:56:0)
[11:09:02.992] Timer tick, asking Buildbucket for the build status
[11:09:03.199] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:09:03.199] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:57:0) after 1m0s
[11:10:03.229] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:57:0)
[11:10:03.229] Timer tick, asking Buildbucket for the build status
[11:10:03.486] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:10:03.486] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:58:0) after 1m0s
[11:11:03.604] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:58:0)
[11:11:03.604] Timer tick, asking Buildbucket for the build status
[11:11:04.094] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:11:04.094] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:59:0) after 1m0s
[11:12:04.120] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:59:0)
[11:12:04.120] Timer tick, asking Buildbucket for the build status
[11:12:04.767] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:12:04.767] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:60:0) after 1m0s
[11:13:04.789] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:60:0)
[11:13:04.789] Timer tick, asking Buildbucket for the build status
[11:13:04.982] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:13:04.982] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:61:0) after 1m0s
[11:14:05.166] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:61:0)
[11:14:05.166] Timer tick, asking Buildbucket for the build status
[11:14:06.228] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:14:06.228] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:62:0) after 1m0s
[11:15:06.252] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:62:0)
[11:15:06.252] Timer tick, asking Buildbucket for the build status
[11:15:06.806] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:15:06.806] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:63:0) after 1m0s
[11:16:06.931] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:63:0)
[11:16:06.931] Timer tick, asking Buildbucket for the build status
[11:16:07.082] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:16:07.082] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:64:0) after 1m0s
[11:17:07.145] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:64:0)
[11:17:07.145] Timer tick, asking Buildbucket for the build status
[11:17:07.684] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:17:07.684] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:65:0) after 1m0s
[11:18:07.716] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:65:0)
[11:18:07.716] Timer tick, asking Buildbucket for the build status
[11:18:08.174] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:18:08.174] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:66:0) after 1m0s
[11:19:08.351] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:66:0)
[11:19:08.351] Timer tick, asking Buildbucket for the build status
[11:19:09.131] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:19:09.131] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:67:0) after 1m0s
[11:20:09.156] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:67:0)
[11:20:09.156] Timer tick, asking Buildbucket for the build status
[11:20:09.337] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:20:09.337] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:68:0) after 1m0s
[11:21:09.499] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:68:0)
[11:21:09.499] Timer tick, asking Buildbucket for the build status
[11:21:10.533] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:21:10.533] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:69:0) after 1m0s
[11:22:10.762] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:69:0)
[11:22:10.762] Timer tick, asking Buildbucket for the build status
[11:22:11.066] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:22:11.066] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:70:0) after 1m0s
[11:23:11.154] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:70:0)
[11:23:11.154] Timer tick, asking Buildbucket for the build status
[11:23:11.384] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:23:11.384] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:71:0) after 1m0s
[11:24:11.533] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:71:0)
[11:24:11.533] Timer tick, asking Buildbucket for the build status
[11:24:12.275] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:24:12.275] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:72:0) after 1m0s
[11:25:12.293] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:72:0)
[11:25:12.293] Timer tick, asking Buildbucket for the build status
[11:25:12.536] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:25:12.536] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:73:0) after 1m0s
[11:26:12.564] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:73:0)
[11:26:12.564] Timer tick, asking Buildbucket for the build status
[11:26:13.749] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:26:13.749] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:74:0) after 1m0s
[11:27:13.851] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:74:0)
[11:27:13.851] Timer tick, asking Buildbucket for the build status
[11:27:14.007] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:27:14.007] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:75:0) after 1m0s
[11:28:14.081] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:75:0)
[11:28:14.081] Timer tick, asking Buildbucket for the build status
[11:28:14.432] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:28:14.432] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:76:0) after 1m0s
[11:29:14.483] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:76:0)
[11:29:14.483] Timer tick, asking Buildbucket for the build status
[11:29:14.688] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:29:14.688] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:77:0) after 1m0s
[11:30:14.735] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:77:0)
[11:30:14.735] Timer tick, asking Buildbucket for the build status
[11:30:15.319] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:30:15.319] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:78:0) after 1m0s
[11:31:15.340] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:78:0)
[11:31:15.340] Timer tick, asking Buildbucket for the build status
[11:31:15.537] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:31:15.537] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:79:0) after 1m0s
[11:32:15.562] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:79:0)
[11:32:15.562] Timer tick, asking Buildbucket for the build status
[11:32:16.135] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:32:16.135] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:80:0) after 1m0s
[11:33:16.218] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:80:0)
[11:33:16.218] Timer tick, asking Buildbucket for the build status
[11:33:16.407] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:33:16.407] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:81:0) after 1m0s
[11:34:16.529] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:81:0)
[11:34:16.529] Timer tick, asking Buildbucket for the build status
[11:34:16.977] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:34:16.977] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:82:0) after 1m0s
[11:35:17.095] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:82:0)
[11:35:17.095] Timer tick, asking Buildbucket for the build status
[11:35:17.428] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:35:17.428] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:83:0) after 1m0s
[11:36:17.460] Handling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:83:0)
[11:36:17.460] Timer tick, asking Buildbucket for the build status
[11:36:17.661] Build 8890298921223846688: status "STARTED", result "", failure_reason "", cancelation_reason ""
[11:36:17.661] Scheduling timer "check-buildbucket-build-status" (chromium/ToTiOSDevice:9055728983429946416:84:0) after 1m0s
[11:36:38.847] Received PubSub notification, asking Buildbucket for the build status
[11:36:39.018] Build 8890298921223846688: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[11:36:39.018] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"completed_ts": "1579952198234959",
"created_by": "project:chromium",
"created_ts": "1579947275862768",
"failure_reason": "BUILD_FAILURE",
"id": "8890298921223846688",
"parameters_json": "{\"builder_name\": \"ToTiOSDevice\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"f0aca2de536ceecd6eb66e928051d11e6d11991f\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Failed boringssl_crypto_tests (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\": \"build283-m9\", \"branch\": \"refs/heads/master\", \"buildername\": \"ToTiOSDevice\", \"buildnumber\": 16151, \"got_angle_revision\": \"564eb6f2a98c12d6c35bd9ce716ef94865a914fc\", \"got_dawn_revision\": \"eb1ca45df7676fff92f5b13627ab9c0ccc29c292\", \"got_nacl_revision\": \"3651f6c52037c96e034cc422746768d59182bff3\", \"got_revision\": \"f0aca2de536ceecd6eb66e928051d11e6d11991f\", \"got_revision_cp\": \"refs/heads/master@{#735230}\", \"got_swarming_client_revision\": \"885b3febcc170a60f25795304e60927b77d1e92d\", \"got_swiftshader_revision\": \"748ad200897b5023ba16e527aa1221400f90b4fe\", \"got_v8_revision\": \"ded3dd5b397722ce87c787130cc352afe9f8e35e\", \"got_v8_revision_cp\": \"refs/heads/8.1.281@{#1}\", \"got_webrtc_revision\": \"760fd5249488a7a8698679a026b247423caa7cce\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#30366}\", \"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\", \"revision\": \"f0aca2de536ceecd6eb66e928051d11e6d11991f\", \"swarm_hashes\": {\"0\": \"fd801f6d6a3dfab8594c86d6a8d542875b8f381b\", \"1\": \"935d8b6e5a8a6af037b14a5077956b0456232d68\", \"10\": \"52c7540d7e6d8151c82fc223a86d996dc72ceb6b\", \"11\": \"e2d8b9d5124dce562308cbf6f2ecf70cbd012ff5\", \"12\": \"e64178c0460c4e4ee6efb346df2de9855210c016\", \"13\": \"ffacfc0af08e7041dd15a12b378b083d5cee571d\", \"14\": \"d515f6daf10d6f42b893300760f1ace900bfef0f\", \"15\": \"7213fdd9bc7fc9d91b23e39ce7ce84a4dc57ad93\", \"16\": \"d125a6f014f655840be32c6d4ed5761f30968862\", \"2\": \"498f272e663dde3aea01f463806f7af77b886780\", \"3\": \"2d377703b71466648cc92ca7a09e163d56da67a3\", \"4\": \"0f5856ac39b28991d80bd4d02996451371c191fe\", \"5\": \"9bf7f9e5d2b4de95859aba64ee81e611b2e54400\", \"6\": \"be6e3ed2abca202f79a664b93ef0415e8f30410f\", \"7\": \"4a3cd6082d19379c15f5d4c43000cbb81f395215\", \"8\": \"9422269f78cdba3f61387bfec31824391e24f40e\", \"9\": \"8a72be8ec5110b53001de3f9f975a0e98dc2d733\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_ae5debd901c74ee0906916cb62621bceb2a8b657b42c2e2e9e89a0f6a2e5e53b_v2\", \"git\", \"vpython\", \"xcode_ios_11a1027\"], \"cores\": [\"24\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-E5-2697_v2\"], \"gce\": [\"0\"], \"gpu\": [\"1002\", \"1002:679e\", \"1002:679e-4.0.11-3.2.8\"], \"hidpi\": [\"0\"], \"id\": [\"build283-m9\"], \"mac_model\": [\"MacPro6,1\"], \"machine_type\": [\"n1-standard-16\"], \"os\": [\"Mac\", \"Mac-10.14\", \"Mac-10.14.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.10\"], \"server_version\": [\"4792-2014df3\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-atl\", \"us-atl-golo\", \"us-atl-golo-m9\"]}}, \"ui\": {\"info\": \"Failed boringssl_crypto_tests (iPhone 6s iOS 12.3.1).\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1579947428455457",
"status": "COMPLETED",
"status_changed_ts": "1579947428790677",
"tags": [
"build_address:luci.chromium.ci/ToTiOSDevice/16151",
"builder:ToTiOSDevice",
"buildset:commit/git/f0aca2de536ceecd6eb66e928051d11e6d11991f",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/f0aca2de536ceecd6eb66e928051d11e6d11991f",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9055728983429946416",
"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/8890298921223846688/+/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:49f503c17131a910",
"user_agent:luci-scheduler"
],
"updated_ts": "1579952198321239",
"url": "https://ci.chromium.org/b/8890298921223846688",
"utcnow_ts": "1579952199010858"
}
}
[11:36:39.018] Invocation finished in 1h22m4.642794103s with status FAILED