[18:27:50.561] New invocation is queued and will start shortly
[18:27:52.103] Starting the invocation (attempt 1)
[18:27:52.185] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:27:52.185] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:27:52.185] Buildbucket request:
{
"bucket": "luci.chromium.ci",
"client_operation_id": "9040568256217493984",
"parameters_json": "{\"builder_name\":\"Site Isolation Android\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/chromium/src\",\"revision\":\"2c1110fe42ee047ef29b3f914a4c0d705067ab30\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:Site Isolation Android",
"scheduler_invocation_id:9040568256217493984",
"scheduler_job_id:chromium/Site Isolation Android",
"user_agent:luci-scheduler",
"buildset:commit/git/2c1110fe42ee047ef29b3f914a4c0d705067ab30",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/2c1110fe42ee047ef29b3f914a4c0d705067ab30",
"gitiles_ref:refs/heads/master"
]
}
[18:27:54.315] Buildbucket response:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"created_by": "project:chromium",
"created_ts": "1594405672669131",
"id": "8875138193333377488",
"parameters_json": "{\"builder_name\": \"Site Isolation Android\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"2c1110fe42ee047ef29b3f914a4c0d705067ab30\"}}",
"project": "chromium",
"result_details_json": "{\"properties\": {}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1594405673992483",
"tags": [
"build_address:luci.chromium.ci/Site Isolation Android/45303",
"builder:Site Isolation Android",
"buildset:commit/git/2c1110fe42ee047ef29b3f914a4c0d705067ab30",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/2c1110fe42ee047ef29b3f914a4c0d705067ab30",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9040568256217493984",
"scheduler_job_id:chromium/Site Isolation Android",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8875138193333377488/+/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": "1594405673992631",
"url": "https://ci.chromium.org/b/8875138193333377488",
"utcnow_ts": "1594405674289109"
}
}
[18:27:54.315] Task URL: https://ci.chromium.org/b/8875138193333377488
[18:27:54.315] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:2:0) after 1m0s
[18:28:54.462] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:2:0)
[18:28:54.462] Timer tick, asking Buildbucket for the build status
[18:29:02.183] Build 8875138193333377488: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:29:02.183] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:3:0) after 1m0s
[18:30:03.040] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:3:0)
[18:30:03.040] Timer tick, asking Buildbucket for the build status
[18:30:03.481] Build 8875138193333377488: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:30:03.481] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:4:0) after 1m0s
[18:31:03.776] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:4:0)
[18:31:03.776] Timer tick, asking Buildbucket for the build status
[18:31:04.540] Build 8875138193333377488: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:31:04.540] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:5:0) after 1m0s
[18:32:04.605] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:5:0)
[18:32:04.605] Timer tick, asking Buildbucket for the build status
[18:32:05.314] Build 8875138193333377488: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:32:05.314] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:6:0) after 1m0s
[18:33:05.338] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:6:0)
[18:33:05.338] Timer tick, asking Buildbucket for the build status
[18:33:05.573] Build 8875138193333377488: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:33:05.573] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:7:0) after 1m0s
[18:34:05.598] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:7:0)
[18:34:05.598] Timer tick, asking Buildbucket for the build status
[18:34:09.064] Build 8875138193333377488: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:34:09.064] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:8:0) after 1m0s
[18:34:50.451] Received PubSub notification, asking Buildbucket for the build status
[18:34:50.726] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:35:09.058] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:8:0)
[18:35:09.058] Timer tick, asking Buildbucket for the build status
[18:35:10.147] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:35:10.147] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:10:0) after 1m0s
[18:36:10.182] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:10:0)
[18:36:10.182] Timer tick, asking Buildbucket for the build status
[18:36:10.745] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:36:10.745] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:11:0) after 1m0s
[18:37:10.833] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:11:0)
[18:37:10.833] Timer tick, asking Buildbucket for the build status
[18:37:11.283] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:37:11.283] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:12:0) after 1m0s
[18:38:11.287] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:12:0)
[18:38:11.288] Timer tick, asking Buildbucket for the build status
[18:38:12.547] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:38:12.547] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:13:0) after 1m0s
[18:39:12.598] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:13:0)
[18:39:12.598] Timer tick, asking Buildbucket for the build status
[18:39:13.475] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:39:13.475] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:14:0) after 1m0s
[18:40:13.483] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:14:0)
[18:40:13.483] Timer tick, asking Buildbucket for the build status
[18:40:13.964] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:40:13.964] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:15:0) after 1m0s
[18:41:14.066] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:15:0)
[18:41:14.066] Timer tick, asking Buildbucket for the build status
[18:41:15.194] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:41:15.194] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:16:0) after 1m0s
[18:42:15.379] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:16:0)
[18:42:15.379] Timer tick, asking Buildbucket for the build status
[18:42:16.194] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:42:16.194] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:17:0) after 1m0s
[18:43:16.308] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:17:0)
[18:43:16.308] Timer tick, asking Buildbucket for the build status
[18:43:17.518] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:43:17.518] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:18:0) after 1m0s
[18:44:17.571] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:18:0)
[18:44:17.571] Timer tick, asking Buildbucket for the build status
[18:44:17.860] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:44:17.860] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:19:0) after 1m0s
[18:45:17.867] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:19:0)
[18:45:17.867] Timer tick, asking Buildbucket for the build status
[18:45:18.067] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:45:18.067] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:20:0) after 1m0s
[18:46:18.142] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:20:0)
[18:46:18.142] Timer tick, asking Buildbucket for the build status
[18:46:18.352] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:46:18.352] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:21:0) after 1m0s
[18:47:18.449] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:21:0)
[18:47:18.449] Timer tick, asking Buildbucket for the build status
[18:47:19.012] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:47:19.012] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:22:0) after 1m0s
[18:48:19.086] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:22:0)
[18:48:19.086] Timer tick, asking Buildbucket for the build status
[18:48:19.280] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:48:19.280] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:23:0) after 1m0s
[18:49:19.335] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:23:0)
[18:49:19.335] Timer tick, asking Buildbucket for the build status
[18:49:20.290] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:49:20.290] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:24:0) after 1m0s
[18:50:20.350] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:24:0)
[18:50:20.350] Timer tick, asking Buildbucket for the build status
[18:50:21.413] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:21.413] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:25:0) after 1m0s
[18:51:21.475] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:25:0)
[18:51:21.475] Timer tick, asking Buildbucket for the build status
[18:51:22.772] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:51:22.772] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:26:0) after 1m0s
[18:52:22.813] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:26:0)
[18:52:22.813] Timer tick, asking Buildbucket for the build status
[18:52:23.098] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:52:23.098] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:27:0) after 1m0s
[18:53:23.102] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:27:0)
[18:53:23.102] Timer tick, asking Buildbucket for the build status
[18:53:24.282] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:53:24.282] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:28:0) after 1m0s
[18:54:24.264] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:28:0)
[18:54:24.264] Timer tick, asking Buildbucket for the build status
[18:54:24.349] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:54:24.349] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:29:0) after 1m0s
[18:55:24.372] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:29:0)
[18:55:24.372] Timer tick, asking Buildbucket for the build status
[18:55:24.783] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:55:24.783] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:30:0) after 1m0s
[18:56:24.845] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:30:0)
[18:56:24.845] Timer tick, asking Buildbucket for the build status
[18:56:25.146] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:56:25.146] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:31:0) after 1m0s
[18:57:25.198] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:31:0)
[18:57:25.198] Timer tick, asking Buildbucket for the build status
[18:57:25.679] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:57:25.679] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:32:0) after 1m0s
[18:58:25.706] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:32:0)
[18:58:25.706] Timer tick, asking Buildbucket for the build status
[18:58:26.958] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:26.958] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:33:0) after 1m0s
[18:59:27.062] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:33:0)
[18:59:27.062] Timer tick, asking Buildbucket for the build status
[18:59:28.431] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:59:28.431] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:34:0) after 1m0s
[19:00:28.497] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:34:0)
[19:00:28.497] Timer tick, asking Buildbucket for the build status
[19:00:29.022] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:00:29.022] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:35:0) after 1m0s
[19:01:29.055] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:35:0)
[19:01:29.055] Timer tick, asking Buildbucket for the build status
[19:01:29.200] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:01:29.200] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:36:0) after 1m0s
[19:02:29.281] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:36:0)
[19:02:29.281] Timer tick, asking Buildbucket for the build status
[19:02:29.391] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:02:29.391] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:37:0) after 1m0s
[19:03:29.471] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:37:0)
[19:03:29.472] Timer tick, asking Buildbucket for the build status
[19:03:30.705] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:03:30.705] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:38:0) after 1m0s
[19:04:30.773] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:38:0)
[19:04:30.773] Timer tick, asking Buildbucket for the build status
[19:04:30.971] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:04:30.971] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:39:0) after 1m0s
[19:05:31.104] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:39:0)
[19:05:31.104] Timer tick, asking Buildbucket for the build status
[19:05:31.430] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:05:31.430] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:40:0) after 1m0s
[19:06:31.484] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:40:0)
[19:06:31.484] Timer tick, asking Buildbucket for the build status
[19:06:33.745] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:06:33.745] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:41:0) after 1m0s
[19:07:33.775] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:41:0)
[19:07:33.775] Timer tick, asking Buildbucket for the build status
[19:07:33.884] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:07:33.884] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:42:0) after 1m0s
[19:08:33.944] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:42:0)
[19:08:33.944] Timer tick, asking Buildbucket for the build status
[19:08:35.446] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:08:35.446] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:43:0) after 1m0s
[19:09:35.475] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:43:0)
[19:09:35.475] Timer tick, asking Buildbucket for the build status
[19:09:36.160] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:09:36.160] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:44:0) after 1m0s
[19:10:36.215] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:44:0)
[19:10:36.215] Timer tick, asking Buildbucket for the build status
[19:10:38.467] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:10:38.467] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:45:0) after 1m0s
[19:11:38.489] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:45:0)
[19:11:38.489] Timer tick, asking Buildbucket for the build status
[19:11:38.581] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:11:38.581] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:46:0) after 1m0s
[19:12:38.576] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:46:0)
[19:12:38.576] Timer tick, asking Buildbucket for the build status
[19:12:38.729] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:12:38.729] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:47:0) after 1m0s
[19:13:38.879] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:47:0)
[19:13:38.879] Timer tick, asking Buildbucket for the build status
[19:13:41.604] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:13:41.604] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:48:0) after 1m0s
[19:14:41.632] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:48:0)
[19:14:41.632] Timer tick, asking Buildbucket for the build status
[19:14:41.787] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:14:41.787] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:49:0) after 1m0s
[19:15:41.770] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:49:0)
[19:15:41.770] Timer tick, asking Buildbucket for the build status
[19:15:42.319] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:15:42.319] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:50:0) after 1m0s
[19:16:42.385] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:50:0)
[19:16:42.385] Timer tick, asking Buildbucket for the build status
[19:16:42.694] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:16:42.694] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:51:0) after 1m0s
[19:17:42.753] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:51:0)
[19:17:42.753] Timer tick, asking Buildbucket for the build status
[19:17:43.332] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:17:43.332] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:52:0) after 1m0s
[19:18:43.407] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:52:0)
[19:18:43.407] Timer tick, asking Buildbucket for the build status
[19:18:43.690] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:18:43.690] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:53:0) after 1m0s
[19:19:43.721] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:53:0)
[19:19:43.721] Timer tick, asking Buildbucket for the build status
[19:19:44.072] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:19:44.072] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:54:0) after 1m0s
[19:20:44.108] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:54:0)
[19:20:44.108] Timer tick, asking Buildbucket for the build status
[19:20:45.427] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:20:45.427] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:55:0) after 1m0s
[19:21:45.415] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:55:0)
[19:21:45.415] Timer tick, asking Buildbucket for the build status
[19:21:45.559] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:21:45.559] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:56:0) after 1m0s
[19:22:45.546] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:56:0)
[19:22:45.546] Timer tick, asking Buildbucket for the build status
[19:22:45.727] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:22:45.727] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:57:0) after 1m0s
[19:23:45.732] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:57:0)
[19:23:45.732] Timer tick, asking Buildbucket for the build status
[19:23:47.660] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:23:47.660] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:58:0) after 1m0s
[19:24:47.724] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:58:0)
[19:24:47.724] Timer tick, asking Buildbucket for the build status
[19:24:47.889] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:24:47.889] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:59:0) after 1m0s
[19:25:47.911] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:59:0)
[19:25:47.911] Timer tick, asking Buildbucket for the build status
[19:25:48.082] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:25:48.082] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:60:0) after 1m0s
[19:26:48.116] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:60:0)
[19:26:48.116] Timer tick, asking Buildbucket for the build status
[19:26:48.361] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:26:48.361] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:61:0) after 1m0s
[19:27:48.398] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:61:0)
[19:27:48.398] Timer tick, asking Buildbucket for the build status
[19:27:49.952] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:27:49.952] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:62:0) after 1m0s
[19:28:50.012] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:62:0)
[19:28:50.012] Timer tick, asking Buildbucket for the build status
[19:28:50.138] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:28:50.138] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:63:0) after 1m0s
[19:29:50.278] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:63:0)
[19:29:50.278] Timer tick, asking Buildbucket for the build status
[19:29:50.602] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:29:50.602] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:64:0) after 1m0s
[19:30:50.613] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:64:0)
[19:30:50.614] Timer tick, asking Buildbucket for the build status
[19:30:51.175] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:30:51.175] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:65:0) after 1m0s
[19:31:51.291] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:65:0)
[19:31:51.291] Timer tick, asking Buildbucket for the build status
[19:31:51.763] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:31:51.763] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:66:0) after 1m0s
[19:32:51.853] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:66:0)
[19:32:51.853] Timer tick, asking Buildbucket for the build status
[19:32:51.929] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:32:51.929] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:67:0) after 1m0s
[19:33:51.948] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:67:0)
[19:33:51.948] Timer tick, asking Buildbucket for the build status
[19:33:53.458] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:33:53.458] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:68:0) after 1m0s
[19:34:53.503] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:68:0)
[19:34:53.503] Timer tick, asking Buildbucket for the build status
[19:34:53.720] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:34:53.720] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:69:0) after 1m0s
[19:35:53.777] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:69:0)
[19:35:53.777] Timer tick, asking Buildbucket for the build status
[19:35:53.889] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:35:53.889] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:70:0) after 1m0s
[19:36:53.934] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:70:0)
[19:36:53.934] Timer tick, asking Buildbucket for the build status
[19:36:54.152] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:36:54.152] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:71:0) after 1m0s
[19:37:54.191] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:71:0)
[19:37:54.191] Timer tick, asking Buildbucket for the build status
[19:37:54.363] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:37:54.363] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:72:0) after 1m0s
[19:38:54.391] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:72:0)
[19:38:54.391] Timer tick, asking Buildbucket for the build status
[19:38:54.466] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:38:54.466] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:73:0) after 1m0s
[19:39:54.793] Handling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:73:0)
[19:39:54.793] Timer tick, asking Buildbucket for the build status
[19:39:55.039] Build 8875138193333377488: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:39:55.039] Scheduling timer "check-buildbucket-build-status" (chromium/Site Isolation Android:9040568256217493984:74:0) after 1m0s
[19:39:56.036] Received PubSub notification, asking Buildbucket for the build status
[19:39:56.163] Build 8875138193333377488: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[19:39:56.163] Buildbucket build:
{
"build": {
"bucket": "luci.chromium.ci",
"canary": true,
"canary_preference": "CANARY",
"completed_ts": "1594409995716556",
"created_by": "project:chromium",
"created_ts": "1594405672669131",
"failure_reason": "BUILD_FAILURE",
"id": "8875138193333377488",
"parameters_json": "{\"builder_name\": \"Site Isolation Android\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"2c1110fe42ee047ef29b3f914a4c0d705067ab30\"}}",
"project": "chromium",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"#### Step _compile_ failed. Error logs are shown below:\\n```\\n[55292/58418] ACTION //chrome/android:chrome_test_java__errorprone(//build/toolchain/android:android_clang_arm64)\\nFAILED: obj/chrome/android/chrome_test_java__errorprone.errorprone.stamp\\n/b/s/w/ir/cipd_bin_packages/cpython/bin/python ../../build/android/gyp/compile_java.py --depfile=gen...(too long)\\nTraceback (most recent call last):\\nFile \\\"../../build/android/gyp/compile_java.py\\\", line 761, in \u003cmodule\u003e\\nsys.exit(main(sys.argv[1:]))\\nFile \\\"../../build/android/gyp/compile_java.py\\\", line 757, in main\\noutput_paths=output_paths)\\nFile \\\"/b/s/w/ir/cache/builder/src/build/android/gyp/util/md5_check.py\\\", line 64, in CallAndWriteDepfileIfStale\\ntrack_subpaths_allowlist=track_subpaths_allowlist)\\n```\\n##### ...The message was too long...\\n#### More information in raw_io.output[failure_summary]\"}, \"properties\": {\"$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-east1-d-8-41-u8ku\", \"branch\": \"refs/heads/master\", \"buildername\": \"Site Isolation Android\", \"buildnumber\": 45303, \"got_angle_revision\": \"0a768f2435334a747df38c4bd557603ede3b472d\", \"got_dawn_revision\": \"479689912ee2fa90e38b4b367dbc4a1925ff9a08\", \"got_nacl_revision\": \"fd20fafa8ec19700e12daa031bf792bae8b6bb21\", \"got_revision\": \"2c1110fe42ee047ef29b3f914a4c0d705067ab30\", \"got_revision_cp\": \"refs/heads/master@{#787297}\", \"got_swarming_client_revision\": \"4c095d04179dc725a300085ae21fe3b79900d072\", \"got_swiftshader_revision\": \"6cd27bab06f428386b9acb5241c1d50d8a290a5c\", \"got_v8_revision\": \"13128e29b8081032f01889ed6c84d7cca6915188\", \"got_v8_revision_cp\": \"refs/heads/8.6.109@{#1}\", \"got_webrtc_revision\": \"8df59bc74ebb4d0b8e5d80a8b4f5c674db2a9c4d\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#31703}\", \"mastername\": \"chromium.fyi\", \"path_config\": \"generic\", \"recipe\": \"chromium\", \"repository\": \"https://chromium.googlesource.com/chromium/src\", \"revision\": \"2c1110fe42ee047ef29b3f914a4c0d705067ab30\"}, \"swarming\": {\"bot_dimensions\": {\"builderless\": [\"1\"], \"caches\": [\"builder_183475f4160d234fde696caafe8010dac7c08c414ef655d369fdf44dcd84c812_v2\", \"builder_26ee0c713798d591dc066c3b18aba10c428b81e49e5d430ca5b1f8f50ef6f654_v2\", \"builder_349392596e0d17d3422c55529f4e230875f36ec061130c176581539a4c7cd365_v2\", \"builder_53a0dbabd2cebac1b8e64bcbfab336eb0021d1dc40b2d4ba5321eb0a070d508c_v2\", \"builder_573c606f18492d6cde6d25a02b12203725732038b1c2909b0b80126d2afb25c2_v2\", \"builder_609b54f795c46f6da98bce3e3c3edeb2c2e2d72c7759cc5040a86edccd734c7c_v2\", \"builder_bea46eaeedb7de1bd52f00a0308b818fe481ae542888a2fa5825ab1ef5ba3493_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"google.com:chromecompute\"], \"gpu\": [\"none\"], \"id\": [\"luci-chromium-ci-xenial-us-east1-d-8-41-u8ku\"], \"image\": [\"chrome-xenial-20052400-59eb8623c93\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16.04\"], \"pool\": [\"luci.chromium.ci\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5378-e275056\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-east\", \"us-east1\", \"us-east1-d\"]}}, \"ui\": {\"info\": \"#### Step _compile_ failed. Error logs are shown below:\\n```\\n[55292/58418] ACTION //chrome/android:chrome_test_java__errorprone(//build/toolchain/android:android_clang_arm64)\\nFAILED: obj/chrome/android/chrome_test_java__errorprone.errorprone.stamp\\n/b/s/w/ir/cipd_bin_packages/cpython/bin/python ../../build/android/gyp/compile_java.py --depfile=gen...(too long)\\nTraceback (most recent call last):\\nFile \\\"../../build/android/gyp/compile_java.py\\\", line 761, in \u003cmodule\u003e\\nsys.exit(main(sys.argv[1:]))\\nFile \\\"../../build/android/gyp/compile_java.py\\\", line 757, in main\\noutput_paths=output_paths)\\nFile \\\"/b/s/w/ir/cache/builder/src/build/android/gyp/util/md5_check.py\\\", line 64, in CallAndWriteDepfileIfStale\\ntrack_subpaths_allowlist=track_subpaths_allowlist)\\n```\\n##### ...The message was too long...\\n#### More information in raw_io.output[failure_summary]\"}}",
"service_account": "chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1594406088410323",
"status": "COMPLETED",
"status_changed_ts": "1594406088949148",
"tags": [
"build_address:luci.chromium.ci/Site Isolation Android/45303",
"builder:Site Isolation Android",
"buildset:commit/git/2c1110fe42ee047ef29b3f914a4c0d705067ab30",
"buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/2c1110fe42ee047ef29b3f914a4c0d705067ab30",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9040568256217493984",
"scheduler_job_id:chromium/Site Isolation Android",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/chromium/buildbucket/cr-buildbucket.appspot.com/8875138193333377488/+/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:4d52cd667d813410",
"user_agent:luci-scheduler"
],
"updated_ts": "1594409995853492",
"url": "https://ci.chromium.org/b/8875138193333377488",
"utcnow_ts": "1594409996153506"
}
}
[19:39:56.163] Invocation finished in 1h12m5.628302042s with status FAILED