[09:12:08.178] New invocation is queued and will start shortly
[09:12:09.337] Starting the invocation (attempt 1)
[09:12:09.385] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[09:12:09.385] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[09:12:09.385] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9036254563844577888",
"parameters_json": "{\"builder_name\":\"android-code-coverage-native\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"ad15c8ce99ced75169e377b7aa88302b98b47d2a\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:android-code-coverage-native",
"scheduler_invocation_id:9036254563844577888",
"scheduler_job_id:chromium/android-code-coverage-native",
"user_agent:luci-scheduler",
"buildset:commit/git/ad15c8ce99ced75169e377b7aa88302b98b47d2a",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ad15c8ce99ced75169e377b7aa88302b98b47d2a",
"gitiles_ref:refs/heads/master"
]
}
[09:12:11.214] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1598519529562063",
"id": "8870824501727842336",
"parameters_json": "{\"builder_name\": \"android-code-coverage-native\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"ad15c8ce99ced75169e377b7aa88302b98b47d2a\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1598519530853552",
"tags": [
"build_address:luci.chromium.ci/android-code-coverage-native/8249",
"builder:android-code-coverage-native",
"buildset:commit/git/ad15c8ce99ced75169e377b7aa88302b98b47d2a",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ad15c8ce99ced75169e377b7aa88302b98b47d2a",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9036254563844577888",
"scheduler_job_id:chromium/android-code-coverage-native",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8870824501727842336/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1598519530853771",
"url": "https://ci.chromium.org/b/8870824501727842336",
"utcnow_ts": "1598519531200140"
}
}
[09:12:11.214] Task URL: https://ci.chromium.org/b/8870824501727842336
[09:12:11.214] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:2:0) after 1m0s
[09:13:02.552] Received PubSub notification, asking Buildbucket for the build status
[09:13:02.839] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:13:11.224] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:2:0)
[09:13:11.224] Timer tick, asking Buildbucket for the build status
[09:13:11.387] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:13:11.387] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:4:0) after 1m0s
[09:14:11.408] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:4:0)
[09:14:11.408] Timer tick, asking Buildbucket for the build status
[09:14:11.521] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:14:11.521] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:5:0) after 1m0s
[09:15:11.541] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:5:0)
[09:15:11.541] Timer tick, asking Buildbucket for the build status
[09:15:11.663] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:15:11.663] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:6:0) after 1m0s
[09:16:11.685] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:6:0)
[09:16:11.685] Timer tick, asking Buildbucket for the build status
[09:16:11.815] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:16:11.815] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:7:0) after 1m0s
[09:17:11.852] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:7:0)
[09:17:11.852] Timer tick, asking Buildbucket for the build status
[09:17:13.002] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:17:13.002] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:8:0) after 1m0s
[09:18:13.096] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:8:0)
[09:18:13.096] Timer tick, asking Buildbucket for the build status
[09:18:13.267] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:18:13.267] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:9:0) after 1m0s
[09:19:13.292] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:9:0)
[09:19:13.292] Timer tick, asking Buildbucket for the build status
[09:19:13.363] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:19:13.363] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:10:0) after 1m0s
[09:20:13.391] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:10:0)
[09:20:13.391] Timer tick, asking Buildbucket for the build status
[09:20:13.534] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:20:13.534] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:11:0) after 1m0s
[09:21:13.585] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:11:0)
[09:21:13.585] Timer tick, asking Buildbucket for the build status
[09:21:13.904] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:21:13.904] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:12:0) after 1m0s
[09:22:13.929] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:12:0)
[09:22:13.929] Timer tick, asking Buildbucket for the build status
[09:22:14.076] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:22:14.076] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:13:0) after 1m0s
[09:23:14.115] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:13:0)
[09:23:14.115] Timer tick, asking Buildbucket for the build status
[09:23:14.228] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:23:14.228] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:14:0) after 1m0s
[09:24:14.256] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:14:0)
[09:24:14.256] Timer tick, asking Buildbucket for the build status
[09:24:14.324] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:24:14.324] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:15:0) after 1m0s
[09:25:14.363] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:15:0)
[09:25:14.363] Timer tick, asking Buildbucket for the build status
[09:25:14.627] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:25:14.627] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:16:0) after 1m0s
[09:26:14.702] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:16:0)
[09:26:14.702] Timer tick, asking Buildbucket for the build status
[09:26:14.770] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:26:14.770] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:17:0) after 1m0s
[09:27:14.750] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:17:0)
[09:27:14.750] Timer tick, asking Buildbucket for the build status
[09:27:14.887] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:27:14.887] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:18:0) after 1m0s
[09:28:14.900] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:18:0)
[09:28:14.900] Timer tick, asking Buildbucket for the build status
[09:28:14.980] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:28:14.980] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:19:0) after 1m0s
[09:29:14.997] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:19:0)
[09:29:14.997] Timer tick, asking Buildbucket for the build status
[09:29:15.314] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:29:15.314] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:20:0) after 1m0s
[09:30:15.341] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:20:0)
[09:30:15.341] Timer tick, asking Buildbucket for the build status
[09:30:15.418] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:30:15.418] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:21:0) after 1m0s
[09:31:15.423] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:21:0)
[09:31:15.423] Timer tick, asking Buildbucket for the build status
[09:31:15.545] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:31:15.545] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:22:0) after 1m0s
[09:32:15.604] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:22:0)
[09:32:15.604] Timer tick, asking Buildbucket for the build status
[09:32:15.716] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:32:15.716] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:23:0) after 1m0s
[09:33:15.744] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:23:0)
[09:33:15.744] Timer tick, asking Buildbucket for the build status
[09:33:15.913] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:33:15.913] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:24:0) after 1m0s
[09:34:15.969] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:24:0)
[09:34:15.969] Timer tick, asking Buildbucket for the build status
[09:34:16.430] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:34:16.430] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:25:0) after 1m0s
[09:35:16.457] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:25:0)
[09:35:16.457] Timer tick, asking Buildbucket for the build status
[09:35:16.623] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:35:16.623] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:26:0) after 1m0s
[09:36:16.654] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:26:0)
[09:36:16.654] Timer tick, asking Buildbucket for the build status
[09:36:17.303] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:36:17.303] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:27:0) after 1m0s
[09:37:17.371] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:27:0)
[09:37:17.371] Timer tick, asking Buildbucket for the build status
[09:37:17.518] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:37:17.518] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:28:0) after 1m0s
[09:38:17.576] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:28:0)
[09:38:17.576] Timer tick, asking Buildbucket for the build status
[09:38:17.705] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:38:17.705] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:29:0) after 1m0s
[09:39:17.760] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:29:0)
[09:39:17.761] Timer tick, asking Buildbucket for the build status
[09:39:17.967] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:39:17.967] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:30:0) after 1m0s
[09:40:18.042] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:30:0)
[09:40:18.042] Timer tick, asking Buildbucket for the build status
[09:40:18.229] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:40:18.229] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:31:0) after 1m0s
[09:41:18.249] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:31:0)
[09:41:18.249] Timer tick, asking Buildbucket for the build status
[09:41:18.374] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:41:18.374] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:32:0) after 1m0s
[09:42:18.418] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:32:0)
[09:42:18.418] Timer tick, asking Buildbucket for the build status
[09:42:18.643] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:42:18.643] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:33:0) after 1m0s
[09:43:18.708] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:33:0)
[09:43:18.708] Timer tick, asking Buildbucket for the build status
[09:43:19.314] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:43:19.314] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:34:0) after 1m0s
[09:44:19.322] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:34:0)
[09:44:19.322] Timer tick, asking Buildbucket for the build status
[09:44:20.758] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:44:20.758] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:35:0) after 1m0s
[09:45:20.786] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:35:0)
[09:45:20.786] Timer tick, asking Buildbucket for the build status
[09:45:21.027] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:45:21.027] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:36:0) after 1m0s
[09:46:21.052] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:36:0)
[09:46:21.052] Timer tick, asking Buildbucket for the build status
[09:46:21.195] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:46:21.195] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:37:0) after 1m0s
[09:47:21.221] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:37:0)
[09:47:21.221] Timer tick, asking Buildbucket for the build status
[09:47:21.396] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:47:21.396] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:38:0) after 1m0s
[09:48:21.579] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:38:0)
[09:48:21.579] Timer tick, asking Buildbucket for the build status
[09:48:21.653] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:48:21.653] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:39:0) after 1m0s
[09:49:21.702] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:39:0)
[09:49:21.702] Timer tick, asking Buildbucket for the build status
[09:49:21.837] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:49:21.837] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:40:0) after 1m0s
[09:50:22.109] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:40:0)
[09:50:22.110] Timer tick, asking Buildbucket for the build status
[09:50:22.223] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:50:22.223] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:41:0) after 1m0s
[09:51:22.250] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:41:0)
[09:51:22.250] Timer tick, asking Buildbucket for the build status
[09:51:22.341] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:51:22.341] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:42:0) after 1m0s
[09:52:22.319] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:42:0)
[09:52:22.319] Timer tick, asking Buildbucket for the build status
[09:52:22.544] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:52:22.544] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:43:0) after 1m0s
[09:53:22.584] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:43:0)
[09:53:22.584] Timer tick, asking Buildbucket for the build status
[09:53:22.731] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:53:22.731] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:44:0) after 1m0s
[09:54:22.742] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:44:0)
[09:54:22.742] Timer tick, asking Buildbucket for the build status
[09:54:22.821] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:54:22.821] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:45:0) after 1m0s
[09:55:22.879] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:45:0)
[09:55:22.879] Timer tick, asking Buildbucket for the build status
[09:55:22.965] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:55:22.965] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:46:0) after 1m0s
[09:56:22.997] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:46:0)
[09:56:22.997] Timer tick, asking Buildbucket for the build status
[09:56:23.462] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:56:23.462] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:47:0) after 1m0s
[09:57:23.535] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:47:0)
[09:57:23.535] Timer tick, asking Buildbucket for the build status
[09:57:23.688] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:57:23.688] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:48:0) after 1m0s
[09:58:23.714] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:48:0)
[09:58:23.714] Timer tick, asking Buildbucket for the build status
[09:58:24.110] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:58:24.110] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:49:0) after 1m0s
[09:59:24.156] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:49:0)
[09:59:24.156] Timer tick, asking Buildbucket for the build status
[09:59:24.261] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:59:24.261] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:50:0) after 1m0s
[10:00:24.322] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:50:0)
[10:00:24.322] Timer tick, asking Buildbucket for the build status
[10:00:24.430] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:00:24.430] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:51:0) after 1m0s
[10:01:24.531] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:51:0)
[10:01:24.531] Timer tick, asking Buildbucket for the build status
[10:01:24.640] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:01:24.640] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:52:0) after 1m0s
[10:02:24.754] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:52:0)
[10:02:24.754] Timer tick, asking Buildbucket for the build status
[10:02:24.883] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:02:24.883] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:53:0) after 1m0s
[10:03:24.905] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:53:0)
[10:03:24.905] Timer tick, asking Buildbucket for the build status
[10:03:24.995] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:03:24.995] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:54:0) after 1m0s
[10:04:25.105] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:54:0)
[10:04:25.105] Timer tick, asking Buildbucket for the build status
[10:04:25.213] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:04:25.213] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:55:0) after 1m0s
[10:05:25.323] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:55:0)
[10:05:25.323] Timer tick, asking Buildbucket for the build status
[10:05:25.428] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:05:25.428] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:56:0) after 1m0s
[10:06:25.498] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:56:0)
[10:06:25.498] Timer tick, asking Buildbucket for the build status
[10:06:25.683] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:06:25.683] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:57:0) after 1m0s
[10:07:25.856] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:57:0)
[10:07:25.856] Timer tick, asking Buildbucket for the build status
[10:07:26.029] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:07:26.029] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:58:0) after 1m0s
[10:08:26.557] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:58:0)
[10:08:26.557] Timer tick, asking Buildbucket for the build status
[10:08:26.857] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:08:26.857] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:59:0) after 1m0s
[10:09:27.042] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:59:0)
[10:09:27.042] Timer tick, asking Buildbucket for the build status
[10:09:27.115] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:09:27.115] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:60:0) after 1m0s
[10:10:27.174] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:60:0)
[10:10:27.174] Timer tick, asking Buildbucket for the build status
[10:10:27.313] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:10:27.313] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:61:0) after 1m0s
[10:11:27.368] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:61:0)
[10:11:27.368] Timer tick, asking Buildbucket for the build status
[10:11:27.573] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:11:27.573] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:62:0) after 1m0s
[10:12:27.702] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:62:0)
[10:12:27.702] Timer tick, asking Buildbucket for the build status
[10:12:27.835] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:12:27.835] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:63:0) after 1m0s
[10:13:28.008] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:63:0)
[10:13:28.008] Timer tick, asking Buildbucket for the build status
[10:13:28.079] Build 8870824501727842336: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:13:28.079] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9036254563844577888:64:0) after 1m0s
[10:14:20.688] Received PubSub notification, asking Buildbucket for the build status
[10:14:20.760] Build 8870824501727842336: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[10:14:20.760] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1598523259903935",
"created_by": "project:chromium",
"created_ts": "1598519529562063",
"failure_reason": "BUILD_FAILURE",
"id": "8870824501727842336",
"parameters_json": "{\"builder_name\": \"android-code-coverage-native\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"ad15c8ce99ced75169e377b7aa88302b98b47d2a\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Step('process clang code coverage data for overall test coverage.generate metadata for overall test coverage in 48 tests') (retcode: 1)\"}, \"properties\": {\"$build/code_coverage\": {\"use_clang_coverage\": true}, \"$build/goma\": {\"enable_ats\": true, \"rpc_extra_params\": \"?prod\", \"server_host\": \"goma.chromium.org\"}, \"$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\": \"luci-chromium-ci-xenial-us-central1-c-600-ssd-hm32-3-n251\", \"branch\": \"refs/heads/master\", \"buildername\": \"android-code-coverage-native\", \"buildnumber\": 8249, \"got_angle_revision\": \"97013e85adfceabb4e4c4d95178e186481b82362\", \"got_dawn_revision\": \"8c012e879646b65924817b8dfb75c7073a0b1b02\", \"got_nacl_revision\": \"3008f9e6de122325d8f9dbf02f7cdd51fa1ec306\", \"got_revision\": \"ad15c8ce99ced75169e377b7aa88302b98b47d2a\", \"got_revision_cp\": \"refs/heads/master@{#802161}\", \"got_swarming_client_revision\": \"4c095d04179dc725a300085ae21fe3b79900d072\", \"got_swiftshader_revision\": \"1f48854dae26a2d129ae771e671a2172acb2da86\", \"got_v8_revision\": \"2a00f38a34d5c3dffd2ef5cd1f538534ce7d66af\", \"got_v8_revision_cp\": \"refs/heads/8.7.26@{#1}\", \"got_webrtc_revision\": \"c75c4280763435eeb44785dfc76f098bf06743bb\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31999}\", \"isolate_server\": \"https://isolateserver.appspot.com\", \"mastername\": \"chromium.fyi\", \"path_config\": \"generic\", \"process_coverage_data_failure\": true, \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"ad15c8ce99ced75169e377b7aa88302b98b47d2a\", \"swarm_hashes\": {\"absl_hardening_tests\": \"68a4173cbdd9ca14f036fad6119bb860a1c43197\", \"android_browsertests\": \"9f9d358e6dd423d2584fad7772fd6485881851c0\", \"angle_unittests\": \"bc58c7f7409a6393ea203daaed372fec4f1f6fd7\", \"base_unittests\": \"2031be89b568b1d87cd980499f3cd15fa73268f9\", \"base_util_unittests\": \"89cbc9a14c3b3a71bf8b633b89d5e7d1969d5386\", \"blink_common_unittests\": \"c69219d160f99b03a63a9fab4ce9d6b19e544565\", \"blink_heap_unittests\": \"3207de9bc0e2db56206e3889b6570c8527023f28\", \"blink_platform_unittests\": \"02d69cd26563808a2d57f70af043d33c882a07c7\", \"boringssl_crypto_tests\": \"f0153e79a95bf7134b779eb82f40e6591242cb1f\", \"boringssl_ssl_tests\": \"a1b44d0bbb886b86ddfeaec3205432c93823fafd\", \"breakpad_unittests\": \"01d0458b7a3a4aa9116d8e39bd6c260b7891bd7e\", \"capture_unittests\": \"aabaf1ce37f4c94235c7d3d1be66db17f6c72593\", \"cast_unittests\": \"1868e458cfe8c259d8c960448562a24fd242624e\", \"cc_unittests\": \"721ebc37ab525043eb0dd19703792869223ccd0a\", \"crypto_unittests\": \"36e52158f288c9f49faf6cc5840b09f908f26b6a\", \"device_unittests\": \"9a618a990157309d7423b9e735793e25167cee12\", \"display_unittests\": \"121bb6b5ff0f6fb48b53281def65474e3ba8c308\", \"events_unittests\": \"a0843ed10e2e0d8c3668109f53e42eb68d412d31\", \"gcm_unit_tests\": \"b909b968a7faa15c62b51cbb77a45ca712788813\", \"gfx_unittests\": \"919364c1d7c07150fa7be169de5d1030f4bbb4e7\", \"gin_unittests\": \"fae2198f009e2ddd6facbc8f060a28e8956448cf\", \"gl_tests\": \"daa74a1a78e9a430ae23ad21c75b65041c11e007\", \"gl_unittests\": \"429d7d85d9ca247bb594f5ecb2895847c6e8e7a0\", \"google_apis_unittests\": \"720d2db4825921840c4322a986eef72903e4a629\", \"gpu_unittests\": \"7b45026a5f36f3a0d37ce74c34281f39281179f2\", \"gwp_asan_unittests\": \"de6eba92a6362f0df52c58a51fc406c92562c583\", \"ipc_tests\": \"6d63a1a87236f9af7134eaf783d10abe519c9f8c\", \"jingle_unittests\": \"915d9b165ff72846cd9e1625cfc89cdb180d36cc\", \"latency_unittests\": \"8c38dd957dac5dbb33f794432e12ad1a2dd1b9be\", \"libjingle_xmpp_unittests\": \"6bf4cf174723964a1745b5c76c3207c5e3b5dd1b\", \"media_blink_unittests\": \"2cb706e7aad7f6edb74e0424a7e7b7a58fcb6339\", \"media_unittests\": \"19addb466791875d49b5d3459c63ceb34a38250b\", \"midi_unittests\": \"6f1bc686d3850bebac2103d46632ec1a39e53261\", \"mojo_test_apk\": \"077d46908e2b1268cad59188d8856d3075025a36\", \"mojo_unittests\": \"1938bde297a51d4098dc6f6143cb0a310d190c60\", \"net_unittests\": \"0bd05fad3ff4ff3645b7a13a15ff6e193a78a506\", \"sandbox_linux_unittests\": \"e10f6ae446189adc885d0244741060c412ea30bb\", \"services_unittests\": \"ce40bccdfe82abad0dbc356ed176b11ba20316e5\", \"shell_dialogs_unittests\": \"789f7e5a6aa669c8e1cf5221123a1c70aa74b428\", \"skia_unittests\": \"d7a76bd5b5dbd7eb5ba7dc52184b565e2224dfaa\", \"sql_unittests\": \"58e7aadaab19b69707637d6fda7b79535ee412b7\", \"storage_unittests\": \"c5b4bf401759a5e80cdd13ea1a083a3f7aef8f4b\", \"ui_android_unittests\": \"4a24b239a3d0ea7ce59213f57bb88989c7b6e3d5\", \"ui_base_unittests\": \"919ea7cc111456a6b0d823ac3d1c523d8b928d48\", \"ui_touch_selection_unittests\": \"aa6cde4c9a7b6456d9ec6a19c1854798b36a10eb\", \"url_unittests\": \"485fd33c2630bb35847a2bda8f1ad03aaa24d943\", \"viz_unittests\": \"9dae072fd31c03b19e296aa174af8154de863a92\", \"wtf_unittests\": \"6a07ee39157b657a0e2a7879493b5fd1b08dad72\"}, \"swarm_hashes_refs/heads/master(at){#802161}_without_patch\": {\"absl_hardening_tests\": \"68a4173cbdd9ca14f036fad6119bb860a1c43197\", \"android_browsertests\": \"9f9d358e6dd423d2584fad7772fd6485881851c0\", \"angle_unittests\": \"bc58c7f7409a6393ea203daaed372fec4f1f6fd7\", \"base_unittests\": \"2031be89b568b1d87cd980499f3cd15fa73268f9\", \"base_util_unittests\": \"89cbc9a14c3b3a71bf8b633b89d5e7d1969d5386\", \"blink_common_unittests\": \"c69219d160f99b03a63a9fab4ce9d6b19e544565\", \"blink_heap_unittests\": \"3207de9bc0e2db56206e3889b6570c8527023f28\", \"blink_platform_unittests\": \"02d69cd26563808a2d57f70af043d33c882a07c7\", \"boringssl_crypto_tests\": \"f0153e79a95bf7134b779eb82f40e6591242cb1f\", \"boringssl_ssl_tests\": \"a1b44d0bbb886b86ddfeaec3205432c93823fafd\", \"breakpad_unittests\": \"01d0458b7a3a4aa9116d8e39bd6c260b7891bd7e\", \"capture_unittests\": \"aabaf1ce37f4c94235c7d3d1be66db17f6c72593\", \"cast_unittests\": \"1868e458cfe8c259d8c960448562a24fd242624e\", \"cc_unittests\": \"721ebc37ab525043eb0dd19703792869223ccd0a\", \"crypto_unittests\": \"36e52158f288c9f49faf6cc5840b09f908f26b6a\", \"device_unittests\": \"9a618a990157309d7423b9e735793e25167cee12\", \"display_unittests\": \"121bb6b5ff0f6fb48b53281def65474e3ba8c308\", \"events_unittests\": \"a0843ed10e2e0d8c3668109f53e42eb68d412d31\", \"gcm_unit_tests\": \"b909b968a7faa15c62b51cbb77a45ca712788813\", \"gfx_unittests\": \"919364c1d7c07150fa7be169de5d1030f4bbb4e7\", \"gin_unittests\": \"fae2198f009e2ddd6facbc8f060a28e8956448cf\", \"gl_tests\": \"daa74a1a78e9a430ae23ad21c75b65041c11e007\", \"gl_unittests\": \"429d7d85d9ca247bb594f5ecb2895847c6e8e7a0\", \"google_apis_unittests\": \"720d2db4825921840c4322a986eef72903e4a629\", \"gpu_unittests\": \"7b45026a5f36f3a0d37ce74c34281f39281179f2\", \"gwp_asan_unittests\": \"de6eba92a6362f0df52c58a51fc406c92562c583\", \"ipc_tests\": \"6d63a1a87236f9af7134eaf783d10abe519c9f8c\", \"jingle_unittests\": \"915d9b165ff72846cd9e1625cfc89cdb180d36cc\", \"latency_unittests\": \"8c38dd957dac5dbb33f794432e12ad1a2dd1b9be\", \"libjingle_xmpp_unittests\": \"6bf4cf174723964a1745b5c76c3207c5e3b5dd1b\", \"media_blink_unittests\": \"2cb706e7aad7f6edb74e0424a7e7b7a58fcb6339\", \"media_unittests\": \"19addb466791875d49b5d3459c63ceb34a38250b\", \"midi_unittests\": \"6f1bc686d3850bebac2103d46632ec1a39e53261\", \"mojo_test_apk\": \"077d46908e2b1268cad59188d8856d3075025a36\", \"mojo_unittests\": \"1938bde297a51d4098dc6f6143cb0a310d190c60\", \"net_unittests\": \"0bd05fad3ff4ff3645b7a13a15ff6e193a78a506\", \"sandbox_linux_unittests\": \"e10f6ae446189adc885d0244741060c412ea30bb\", \"services_unittests\": \"ce40bccdfe82abad0dbc356ed176b11ba20316e5\", \"shell_dialogs_unittests\": \"789f7e5a6aa669c8e1cf5221123a1c70aa74b428\", \"skia_unittests\": \"d7a76bd5b5dbd7eb5ba7dc52184b565e2224dfaa\", \"sql_unittests\": \"58e7aadaab19b69707637d6fda7b79535ee412b7\", \"storage_unittests\": \"c5b4bf401759a5e80cdd13ea1a083a3f7aef8f4b\", \"ui_android_unittests\": \"4a24b239a3d0ea7ce59213f57bb88989c7b6e3d5\", \"ui_base_unittests\": \"919ea7cc111456a6b0d823ac3d1c523d8b928d48\", \"ui_touch_selection_unittests\": \"aa6cde4c9a7b6456d9ec6a19c1854798b36a10eb\", \"url_unittests\": \"485fd33c2630bb35847a2bda8f1ad03aaa24d943\", \"viz_unittests\": \"9dae072fd31c03b19e296aa174af8154de863a92\", \"wtf_unittests\": \"6a07ee39157b657a0e2a7879493b5fd1b08dad72\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_1cf5addf4d1b07dee05bb817410abedd1ddd14dde2cca1baf3f95933882f5cfd_v2\", \"builder_84527c5af4d4441fc5a14374d256be65769803505d9e2e72cad7cb7913806658_v2\", \"builder_f2ac5903ab08ee4ddab389becac92d3a3647f6b791038f1abef5b06a03e08513_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"32\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Broadwell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-central1-c-600-ssd-hm32-3-n251\"], \"image\": [\"chrome-xenial-20081700-d9392568d25\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"n1-highmem-32\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5498-3454aa6\"], \"ssd\": [\"1\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-c\"]}}, \"ui\": {\"info\": \"Step('process clang code coverage data for overall test coverage.generate metadata for overall test coverage in 48 tests') (retcode: 1)\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1598519581564245",
"status": "COMPLETED",
"status_changed_ts": "1598519582113733",
"tags": [
"build_address:luci.chromium.ci/android-code-coverage-native/8249",
"builder:android-code-coverage-native",
"buildset:commit/git/ad15c8ce99ced75169e377b7aa88302b98b47d2a",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ad15c8ce99ced75169e377b7aa88302b98b47d2a",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9036254563844577888",
"scheduler_job_id:chromium/android-code-coverage-native",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8870824501727842336/+/annotations",
"swarming_tag:luci_project:chromium",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:chromium",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:4e4801df58efcc10",
"user_agent:luci-scheduler"
],
"updated_ts": "1598523260445408",
"url": "https://ci.chromium.org/b/8870824501727842336",
"utcnow_ts": "1598523260752392"
}
}
[10:14:20.760] Invocation finished in 1h2m12.599730327s with status FAILED