[14:46:06.316] New invocation is queued and will start shortly
[14:46:07.431] Starting the invocation (attempt 1)
[14:46:07.502] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[14:46:07.503] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[14:46:07.503] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9039676237062484368",
"parameters_json": "{\"builder_name\":\"android-code-coverage-native\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"46dbabdd67b9bdbbf7cac6837d38b143da236300\"}}",
"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:9039676237062484368",
"scheduler_job_id:chromium/android-code-coverage-native",
"user_agent:luci-scheduler",
"buildset:commit/git/46dbabdd67b9bdbbf7cac6837d38b143da236300",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/46dbabdd67b9bdbbf7cac6837d38b143da236300",
"gitiles_ref:refs/heads/master"
]
}
[14:46:08.710] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"created_by": "project:chromium",
"created_ts": "1595256367655997",
"id": "8874246174988342032",
"parameters_json": "{\"builder_name\": \"android-code-coverage-native\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"46dbabdd67b9bdbbf7cac6837d38b143da236300\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1595256368461483",
"tags": [
"build_address:luci.chromium.ci/android-code-coverage-native/7871",
"builder:android-code-coverage-native",
"buildset:commit/git/46dbabdd67b9bdbbf7cac6837d38b143da236300",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/46dbabdd67b9bdbbf7cac6837d38b143da236300",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9039676237062484368",
"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/8874246174988342032/+/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": "1595256368461626",
"url": "https://ci.chromium.org/b/8874246174988342032",
"utcnow_ts": "1595256368659794"
}
}
[14:46:08.710] Task URL: https://ci.chromium.org/b/8874246174988342032
[14:46:08.710] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:2:0) after 1m0s
[14:47:02.508] Received PubSub notification, asking Buildbucket for the build status
[14:47:02.754] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:08.837] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:2:0)
[14:47:08.837] Timer tick, asking Buildbucket for the build status
[14:47:09.131] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:47:09.131] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:4:0) after 1m0s
[14:48:09.227] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:4:0)
[14:48:09.227] Timer tick, asking Buildbucket for the build status
[14:48:09.358] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:48:09.358] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:5:0) after 1m0s
[14:49:09.626] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:5:0)
[14:49:09.626] Timer tick, asking Buildbucket for the build status
[14:49:09.885] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:49:09.885] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:6:0) after 1m0s
[14:50:09.954] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:6:0)
[14:50:09.954] Timer tick, asking Buildbucket for the build status
[14:50:10.442] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:50:10.443] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:7:0) after 1m0s
[14:51:10.636] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:7:0)
[14:51:10.636] Timer tick, asking Buildbucket for the build status
[14:51:10.791] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:51:10.791] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:8:0) after 1m0s
[14:52:10.896] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:8:0)
[14:52:10.896] Timer tick, asking Buildbucket for the build status
[14:52:11.039] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:52:11.039] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:9:0) after 1m0s
[14:53:11.193] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:9:0)
[14:53:11.193] Timer tick, asking Buildbucket for the build status
[14:53:11.265] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:53:11.265] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:10:0) after 1m0s
[14:54:11.477] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:10:0)
[14:54:11.477] Timer tick, asking Buildbucket for the build status
[14:54:11.806] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:54:11.806] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:11:0) after 1m0s
[14:55:11.995] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:11:0)
[14:55:11.995] Timer tick, asking Buildbucket for the build status
[14:55:12.087] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:55:12.087] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:12:0) after 1m0s
[14:56:12.245] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:12:0)
[14:56:12.245] Timer tick, asking Buildbucket for the build status
[14:56:12.387] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:56:12.387] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:13:0) after 1m0s
[14:57:12.479] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:13:0)
[14:57:12.479] Timer tick, asking Buildbucket for the build status
[14:57:12.574] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:57:12.574] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:14:0) after 1m0s
[14:58:12.790] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:14:0)
[14:58:12.790] Timer tick, asking Buildbucket for the build status
[14:58:13.122] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:58:13.122] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:15:0) after 1m0s
[14:59:13.234] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:15:0)
[14:59:13.234] Timer tick, asking Buildbucket for the build status
[14:59:13.321] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[14:59:13.321] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:16:0) after 1m0s
[15:00:13.546] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:16:0)
[15:00:13.546] Timer tick, asking Buildbucket for the build status
[15:00:13.677] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:00:13.677] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:17:0) after 1m0s
[15:01:13.746] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:17:0)
[15:01:13.746] Timer tick, asking Buildbucket for the build status
[15:01:14.366] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:01:14.366] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:18:0) after 1m0s
[15:02:14.411] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:18:0)
[15:02:14.411] Timer tick, asking Buildbucket for the build status
[15:02:14.672] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:02:14.672] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:19:0) after 1m0s
[15:03:14.740] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:19:0)
[15:03:14.740] Timer tick, asking Buildbucket for the build status
[15:03:15.678] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:03:15.678] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:20:0) after 1m0s
[15:04:15.842] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:20:0)
[15:04:15.842] Timer tick, asking Buildbucket for the build status
[15:04:15.918] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:04:15.918] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:21:0) after 1m0s
[15:05:16.004] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:21:0)
[15:05:16.004] Timer tick, asking Buildbucket for the build status
[15:05:16.167] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:05:16.167] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:22:0) after 1m0s
[15:06:16.399] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:22:0)
[15:06:16.400] Timer tick, asking Buildbucket for the build status
[15:06:16.825] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:06:16.825] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:23:0) after 1m0s
[15:07:16.909] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:23:0)
[15:07:16.909] Timer tick, asking Buildbucket for the build status
[15:07:17.338] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:07:17.338] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:24:0) after 1m0s
[15:08:17.434] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:24:0)
[15:08:17.434] Timer tick, asking Buildbucket for the build status
[15:08:17.577] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:08:17.577] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:25:0) after 1m0s
[15:09:17.699] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:25:0)
[15:09:17.699] Timer tick, asking Buildbucket for the build status
[15:09:18.236] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:09:18.236] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:26:0) after 1m0s
[15:10:18.478] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:26:0)
[15:10:18.478] Timer tick, asking Buildbucket for the build status
[15:10:18.718] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:10:18.718] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:27:0) after 1m0s
[15:11:18.830] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:27:0)
[15:11:18.830] Timer tick, asking Buildbucket for the build status
[15:11:18.917] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:11:18.917] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:28:0) after 1m0s
[15:12:19.065] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:28:0)
[15:12:19.065] Timer tick, asking Buildbucket for the build status
[15:12:19.237] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:12:19.237] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:29:0) after 1m0s
[15:13:19.290] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:29:0)
[15:13:19.290] Timer tick, asking Buildbucket for the build status
[15:13:19.753] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:13:19.753] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:30:0) after 1m0s
[15:14:19.832] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:30:0)
[15:14:19.832] Timer tick, asking Buildbucket for the build status
[15:14:19.992] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:14:19.992] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:31:0) after 1m0s
[15:15:20.038] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:31:0)
[15:15:20.038] Timer tick, asking Buildbucket for the build status
[15:15:20.222] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:15:20.222] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:32:0) after 1m0s
[15:16:20.288] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:32:0)
[15:16:20.288] Timer tick, asking Buildbucket for the build status
[15:16:20.432] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:16:20.432] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:33:0) after 1m0s
[15:17:20.499] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:33:0)
[15:17:20.499] Timer tick, asking Buildbucket for the build status
[15:17:20.866] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:17:20.866] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:34:0) after 1m0s
[15:18:20.901] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:34:0)
[15:18:20.901] Timer tick, asking Buildbucket for the build status
[15:18:21.068] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:18:21.068] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:35:0) after 1m0s
[15:19:21.135] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:35:0)
[15:19:21.135] Timer tick, asking Buildbucket for the build status
[15:19:21.282] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:19:21.282] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:36:0) after 1m0s
[15:20:21.336] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:36:0)
[15:20:21.336] Timer tick, asking Buildbucket for the build status
[15:20:21.413] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:20:21.413] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:37:0) after 1m0s
[15:21:21.557] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:37:0)
[15:21:21.557] Timer tick, asking Buildbucket for the build status
[15:21:21.679] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:21:21.679] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:38:0) after 1m0s
[15:22:21.779] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:38:0)
[15:22:21.779] Timer tick, asking Buildbucket for the build status
[15:22:21.872] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:22:21.872] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:39:0) after 1m0s
[15:23:22.036] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:39:0)
[15:23:22.036] Timer tick, asking Buildbucket for the build status
[15:23:22.204] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:23:22.204] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:40:0) after 1m0s
[15:24:22.347] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:40:0)
[15:24:22.347] Timer tick, asking Buildbucket for the build status
[15:24:22.433] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:24:22.433] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:41:0) after 1m0s
[15:25:22.586] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:41:0)
[15:25:22.586] Timer tick, asking Buildbucket for the build status
[15:25:22.956] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:25:22.956] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:42:0) after 1m0s
[15:26:23.060] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:42:0)
[15:26:23.060] Timer tick, asking Buildbucket for the build status
[15:26:23.148] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:26:23.148] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:43:0) after 1m0s
[15:27:23.194] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:43:0)
[15:27:23.194] Timer tick, asking Buildbucket for the build status
[15:27:23.394] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:27:23.394] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:44:0) after 1m0s
[15:28:23.421] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:44:0)
[15:28:23.421] Timer tick, asking Buildbucket for the build status
[15:28:24.524] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:28:24.524] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:45:0) after 1m0s
[15:29:24.694] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:45:0)
[15:29:24.694] Timer tick, asking Buildbucket for the build status
[15:29:25.987] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:29:25.987] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:46:0) after 1m0s
[15:30:26.190] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:46:0)
[15:30:26.190] Timer tick, asking Buildbucket for the build status
[15:30:26.269] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:30:26.269] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:47:0) after 1m0s
[15:31:26.354] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:47:0)
[15:31:26.354] Timer tick, asking Buildbucket for the build status
[15:31:27.035] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:31:27.035] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:48:0) after 1m0s
[15:32:27.097] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:48:0)
[15:32:27.097] Timer tick, asking Buildbucket for the build status
[15:32:27.168] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:32:27.168] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:49:0) after 1m0s
[15:33:27.274] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:49:0)
[15:33:27.274] Timer tick, asking Buildbucket for the build status
[15:33:27.615] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:33:27.615] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:50:0) after 1m0s
[15:34:27.878] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:50:0)
[15:34:27.878] Timer tick, asking Buildbucket for the build status
[15:34:27.977] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:34:27.977] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:51:0) after 1m0s
[15:35:28.038] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:51:0)
[15:35:28.038] Timer tick, asking Buildbucket for the build status
[15:35:28.292] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:35:28.292] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:52:0) after 1m0s
[15:36:28.316] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:52:0)
[15:36:28.316] Timer tick, asking Buildbucket for the build status
[15:36:28.388] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:36:28.388] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:53:0) after 1m0s
[15:37:28.472] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:53:0)
[15:37:28.472] Timer tick, asking Buildbucket for the build status
[15:37:28.588] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:37:28.588] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:54:0) after 1m0s
[15:38:28.590] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:54:0)
[15:38:28.590] Timer tick, asking Buildbucket for the build status
[15:38:28.806] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:38:28.806] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:55:0) after 1m0s
[15:39:28.912] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:55:0)
[15:39:28.912] Timer tick, asking Buildbucket for the build status
[15:39:29.276] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:39:29.276] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:56:0) after 1m0s
[15:40:29.338] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:56:0)
[15:40:29.338] Timer tick, asking Buildbucket for the build status
[15:40:29.414] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:40:29.414] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:57:0) after 1m0s
[15:41:29.653] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:57:0)
[15:41:29.653] Timer tick, asking Buildbucket for the build status
[15:41:29.795] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:41:29.795] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:58:0) after 1m0s
[15:42:29.852] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:58:0)
[15:42:29.852] Timer tick, asking Buildbucket for the build status
[15:42:29.938] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:42:29.938] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:59:0) after 1m0s
[15:43:30.105] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:59:0)
[15:43:30.105] Timer tick, asking Buildbucket for the build status
[15:43:30.260] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:43:30.260] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:60:0) after 1m0s
[15:44:30.368] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:60:0)
[15:44:30.368] Timer tick, asking Buildbucket for the build status
[15:44:30.449] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:44:30.449] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:61:0) after 1m0s
[15:45:30.505] Handling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:61:0)
[15:45:30.505] Timer tick, asking Buildbucket for the build status
[15:45:30.643] Build 8874246174988342032: status "STARTED", result "", failure_reason "", cancelation_reason ""
[15:45:30.643] Scheduling timer "check-buildbucket-build-status" (chromium/android-code-coverage-native:9039676237062484368:62:0) after 1m0s
[15:45:56.161] Received PubSub notification, asking Buildbucket for the build status
[15:45:56.272] Build 8874246174988342032: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[15:45:56.272] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary_preference": "PROD",
"completed_ts": "1595259954748827",
"created_by": "project:chromium",
"created_ts": "1595256367655997",
"failure_reason": "BUILD_FAILURE",
"id": "8874246174988342032",
"parameters_json": "{\"builder_name\": \"android-code-coverage-native\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"46dbabdd67b9bdbbf7cac6837d38b143da236300\"}}",
"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-m091\", \"branch\": \"refs/heads/master\", \"buildername\": \"android-code-coverage-native\", \"buildnumber\": 7871, \"got_angle_revision\": \"08c4d09493bf22418d7eb75dd936ada79095e088\", \"got_dawn_revision\": \"92ebe87b74f1f7e80fb0e2133c9976715c1b6d46\", \"got_nacl_revision\": \"fd20fafa8ec19700e12daa031bf792bae8b6bb21\", \"got_revision\": \"46dbabdd67b9bdbbf7cac6837d38b143da236300\", \"got_revision_cp\": \"refs/heads/master@{#789933}\", \"got_swarming_client_revision\": \"4c095d04179dc725a300085ae21fe3b79900d072\", \"got_swiftshader_revision\": \"ea6f21a052c97dbfa4890e1d6840db2fe64ba1d8\", \"got_v8_revision\": \"343030c9f9ede70d54c0a4245421457e0a7c7db9\", \"got_v8_revision_cp\": \"refs/heads/8.6.185@{#1}\", \"got_webrtc_revision\": \"fd5df6887258222f1be7ffb15fb1479b13d35aba\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31765}\", \"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\": \"46dbabdd67b9bdbbf7cac6837d38b143da236300\", \"swarm_hashes\": {\"absl_hardening_tests\": \"b967fc9ece6294d1ef968c88d39539aaee2a80b4\", \"android_browsertests\": \"d57b9b5032cc7d02c2a8453d36db407c14206a96\", \"angle_unittests\": \"ea73dcbb2c8419f3c0e1fc01d7618e2ddde35568\", \"base_unittests\": \"7e411f42fd4c0253e6bbee54735f59464f79ff91\", \"base_util_unittests\": \"6575e718d08a03c2b41aec787d15e7af2e064d48\", \"blink_common_unittests\": \"5e7f50425c054e3513014dc0aa6f2cccf4b5b1a3\", \"blink_heap_unittests\": \"3b2e78512ea291e39d37539c454e502a7c1408a6\", \"blink_platform_unittests\": \"965a9bb3f4577d687f92672d616a291932593f13\", \"boringssl_crypto_tests\": \"91d4a1b2db4c2398bd08d9bd9fd597f0b00d8cce\", \"boringssl_ssl_tests\": \"38988690f8646aed46270b8b01108a2265d7ba9a\", \"breakpad_unittests\": \"cdb07b7bbf4d399693b8cd0ff6b36351e08a15c6\", \"capture_unittests\": \"441042efd4a97891e6e274979fb5d7e9b10f7a10\", \"cast_unittests\": \"885c4c21f21ecf498e770c36dff16d424d20c4d3\", \"cc_unittests\": \"d38dfe7a8aa8d22fa81a0227b55ac13229ffa3ff\", \"crypto_unittests\": \"b76a9a2dbde89b7b6ec4570de53e960b0b781f71\", \"device_unittests\": \"1df3dccbf532f6dfde73137055d340c71cf69fcc\", \"display_unittests\": \"5bdebe32cdcbcd873071fdc3ab82bd5a14f9062f\", \"events_unittests\": \"029c57bb6203335b59ff3a1a07d48b77035668f1\", \"gcm_unit_tests\": \"4a13a3a58607a92798f710ffdaf1545e08b895ee\", \"gfx_unittests\": \"6d8a00decc47415891fae0317de6958b62f61354\", \"gin_unittests\": \"ced2c290af973e53de33874ca5257a5bebfb2962\", \"gl_tests\": \"c788bfb183cb97dab5a126b70ccb2ac6e75e9e98\", \"gl_unittests\": \"7f4a78d72bbee0696bc7edbbf71083f7b19ddd8d\", \"google_apis_unittests\": \"119f19404d5c8736e4396128fb5405e4df984d43\", \"gpu_unittests\": \"ed1c4c7e83c70a600fbc6cd2e2994becde295be3\", \"gwp_asan_unittests\": \"8b33a07946b9987ccf9160054af9b831b49cb402\", \"ipc_tests\": \"88d87e70e1f7c6e2bd3fd5a9ed3b6f9dc8a008ee\", \"jingle_unittests\": \"17c2085eb942c93b64dacea1677c73616150f399\", \"latency_unittests\": \"7957f676bf39625d883ea89dbdf4ca6c544382ec\", \"libjingle_xmpp_unittests\": \"4397e86b613c48a14769c0a11d170583bca93b4a\", \"media_blink_unittests\": \"d00b5aabeb8c711c990105a74ca2227770095f7c\", \"media_unittests\": \"c52c377d84f113adc4b279064b81bd02ba1284ba\", \"midi_unittests\": \"ff73b412c68e1cbe5829b92d0c73a675e37f6478\", \"mojo_test_apk\": \"098723cc43cfea2aa4edcae51e3581daa06e3111\", \"mojo_unittests\": \"f5c79180d00b1953206070847354fafdc625d989\", \"net_unittests\": \"edcc70e3b5831d02fd4e1537c7b2ce7184d9ae0d\", \"sandbox_linux_unittests\": \"941d148d3cf250db6fea4817711377ef46e316fa\", \"services_unittests\": \"565419bd8e6a5e597443e07b833214fc3603e45c\", \"shell_dialogs_unittests\": \"be6827809ec02539a77c68be35a863bc34b994bd\", \"skia_unittests\": \"6ef4a4888461f33b6889e479847d1a613d0a5912\", \"sql_unittests\": \"45aeb5f202c7babac98d014cda6c8dbd0f74523b\", \"storage_unittests\": \"498c8854301e269069feb3f50bf775cb4997554c\", \"ui_android_unittests\": \"e95dd294566b1e6c9f9fad2f289bd210508b371e\", \"ui_base_unittests\": \"2d6dc4cdd9705f0df41016bce375fdd9d044fe56\", \"ui_touch_selection_unittests\": \"ec4e105a73a5a477250f949d922ce30c483cdd78\", \"url_unittests\": \"1d37330b2b0b1139ca01991d2cd880900fc291bd\", \"viz_unittests\": \"3d144a0ce897aac4cdaa8efc3f42f2a2343fb6b3\", \"wtf_unittests\": \"44ed79d15b0aefd7b907925cda6840cdfc466e60\"}, \"swarm_hashes_refs/heads/master(at){#789933}_without_patch\": {\"absl_hardening_tests\": \"b967fc9ece6294d1ef968c88d39539aaee2a80b4\", \"android_browsertests\": \"d57b9b5032cc7d02c2a8453d36db407c14206a96\", \"angle_unittests\": \"ea73dcbb2c8419f3c0e1fc01d7618e2ddde35568\", \"base_unittests\": \"7e411f42fd4c0253e6bbee54735f59464f79ff91\", \"base_util_unittests\": \"6575e718d08a03c2b41aec787d15e7af2e064d48\", \"blink_common_unittests\": \"5e7f50425c054e3513014dc0aa6f2cccf4b5b1a3\", \"blink_heap_unittests\": \"3b2e78512ea291e39d37539c454e502a7c1408a6\", \"blink_platform_unittests\": \"965a9bb3f4577d687f92672d616a291932593f13\", \"boringssl_crypto_tests\": \"91d4a1b2db4c2398bd08d9bd9fd597f0b00d8cce\", \"boringssl_ssl_tests\": \"38988690f8646aed46270b8b01108a2265d7ba9a\", \"breakpad_unittests\": \"cdb07b7bbf4d399693b8cd0ff6b36351e08a15c6\", \"capture_unittests\": \"441042efd4a97891e6e274979fb5d7e9b10f7a10\", \"cast_unittests\": \"885c4c21f21ecf498e770c36dff16d424d20c4d3\", \"cc_unittests\": \"d38dfe7a8aa8d22fa81a0227b55ac13229ffa3ff\", \"crypto_unittests\": \"b76a9a2dbde89b7b6ec4570de53e960b0b781f71\", \"device_unittests\": \"1df3dccbf532f6dfde73137055d340c71cf69fcc\", \"display_unittests\": \"5bdebe32cdcbcd873071fdc3ab82bd5a14f9062f\", \"events_unittests\": \"029c57bb6203335b59ff3a1a07d48b77035668f1\", \"gcm_unit_tests\": \"4a13a3a58607a92798f710ffdaf1545e08b895ee\", \"gfx_unittests\": \"6d8a00decc47415891fae0317de6958b62f61354\", \"gin_unittests\": \"ced2c290af973e53de33874ca5257a5bebfb2962\", \"gl_tests\": \"c788bfb183cb97dab5a126b70ccb2ac6e75e9e98\", \"gl_unittests\": \"7f4a78d72bbee0696bc7edbbf71083f7b19ddd8d\", \"google_apis_unittests\": \"119f19404d5c8736e4396128fb5405e4df984d43\", \"gpu_unittests\": \"ed1c4c7e83c70a600fbc6cd2e2994becde295be3\", \"gwp_asan_unittests\": \"8b33a07946b9987ccf9160054af9b831b49cb402\", \"ipc_tests\": \"88d87e70e1f7c6e2bd3fd5a9ed3b6f9dc8a008ee\", \"jingle_unittests\": \"17c2085eb942c93b64dacea1677c73616150f399\", \"latency_unittests\": \"7957f676bf39625d883ea89dbdf4ca6c544382ec\", \"libjingle_xmpp_unittests\": \"4397e86b613c48a14769c0a11d170583bca93b4a\", \"media_blink_unittests\": \"d00b5aabeb8c711c990105a74ca2227770095f7c\", \"media_unittests\": \"c52c377d84f113adc4b279064b81bd02ba1284ba\", \"midi_unittests\": \"ff73b412c68e1cbe5829b92d0c73a675e37f6478\", \"mojo_test_apk\": \"098723cc43cfea2aa4edcae51e3581daa06e3111\", \"mojo_unittests\": \"f5c79180d00b1953206070847354fafdc625d989\", \"net_unittests\": \"edcc70e3b5831d02fd4e1537c7b2ce7184d9ae0d\", \"sandbox_linux_unittests\": \"941d148d3cf250db6fea4817711377ef46e316fa\", \"services_unittests\": \"565419bd8e6a5e597443e07b833214fc3603e45c\", \"shell_dialogs_unittests\": \"be6827809ec02539a77c68be35a863bc34b994bd\", \"skia_unittests\": \"6ef4a4888461f33b6889e479847d1a613d0a5912\", \"sql_unittests\": \"45aeb5f202c7babac98d014cda6c8dbd0f74523b\", \"storage_unittests\": \"498c8854301e269069feb3f50bf775cb4997554c\", \"ui_android_unittests\": \"e95dd294566b1e6c9f9fad2f289bd210508b371e\", \"ui_base_unittests\": \"2d6dc4cdd9705f0df41016bce375fdd9d044fe56\", \"ui_touch_selection_unittests\": \"ec4e105a73a5a477250f949d922ce30c483cdd78\", \"url_unittests\": \"1d37330b2b0b1139ca01991d2cd880900fc291bd\", \"viz_unittests\": \"3d144a0ce897aac4cdaa8efc3f42f2a2343fb6b3\", \"wtf_unittests\": \"44ed79d15b0aefd7b907925cda6840cdfc466e60\"}}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_1cf5addf4d1b07dee05bb817410abedd1ddd14dde2cca1baf3f95933882f5cfd_v2\", \"builder_84527c5af4d4441fc5a14374d256be65769803505d9e2e72cad7cb7913806658_v2\", \"builder_f0e85433ca60e21ba10033b857841d88af052436c6cb8411b561ff60a2c00a4a_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-m091\"], \"image\": [\"chrome-xenial-20052400-59eb8623c93\"], \"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\": [\"5409-9d77717\"], \"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": "1595256421772354",
"status": "COMPLETED",
"status_changed_ts": "1595256422287379",
"tags": [
"build_address:luci.chromium.ci/android-code-coverage-native/7871",
"builder:android-code-coverage-native",
"buildset:commit/git/46dbabdd67b9bdbbf7cac6837d38b143da236300",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/46dbabdd67b9bdbbf7cac6837d38b143da236300",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9039676237062484368",
"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/8874246174988342032/+/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:4d8581f6f4ec8310",
"user_agent:luci-scheduler"
],
"updated_ts": "1595259955751699",
"url": "https://ci.chromium.org/b/8874246174988342032",
"utcnow_ts": "1595259956258713"
}
}
[15:45:56.272] Invocation finished in 59m49.978581545s with status FAILED