[04:10:58.454] New invocation is queued and will start shortly
[04:10:58.454] Triggered by user:infra-codesearch@chops-service-accounts.iam.gserviceaccount.com
[04:10:59.534] Starting the invocation (attempt 1)
[04:10:59.589] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[04:10:59.589] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[04:10:59.589] Buildbucket request:
{
"bucket": "luci.infra.codesearch",
"client_operation_id": "9082840352053364000",
"parameters_json": "{\"builder_name\":\"codesearch-gen-chromium-win\",\"properties\":{\"root_solution_revision\":\"e01c3e081ff3ed2a7370c68091a1d08d4a22e538\",\"root_solution_revision_timestamp\":1554090243}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:codesearch-gen-chromium-win",
"scheduler_invocation_id:9082840352053364000",
"scheduler_job_id:infra/codesearch-gen-chromium-win",
"user_agent:luci-scheduler",
"parent_buildername:codesearch-gen-chromium-initiator",
"parent_buildnumber:8076",
"user_agent:recipe"
]
}
[04:11:00.280] Buildbucket response:
{
"build": {
"bucket": "luci.infra.codesearch",
"canary_preference": "AUTO",
"created_by": "project:infra",
"created_ts": "1554091859698805",
"id": "8917410290083514128",
"parameters_json": "{\"builder_name\": \"codesearch-gen-chromium-win\", \"properties\": {\"root_solution_revision\": \"e01c3e081ff3ed2a7370c68091a1d08d4a22e538\", \"root_solution_revision_timestamp\": 1554090243}}",
"project": "infra",
"result_details_json": "{\"properties\": {}}",
"service_account": "infra-codesearch@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1554091860120249",
"tags": [
"build_address:luci.infra.codesearch/codesearch-gen-chromium-win/3447",
"builder:codesearch-gen-chromium-win",
"parent_buildername:codesearch-gen-chromium-initiator",
"parent_buildnumber:8076",
"scheduler_invocation_id:9082840352053364000",
"scheduler_job_id:infra/codesearch-gen-chromium-win",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8917410290083514128/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:recipe_name:chromium_codesearch",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1554091860120381",
"url": "https://ci.chromium.org/b/8917410290083514128",
"utcnow_ts": "1554091860270343"
}
}
[04:11:00.280] Task URL: https://ci.chromium.org/b/8917410290083514128
[04:11:00.280] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:2:0) after 1m0s
[04:12:00.258] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:2:0)
[04:12:00.258] Timer tick, asking Buildbucket for the build status
[04:12:00.570] Build 8917410290083514128: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[04:12:00.571] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:3:0) after 1m0s
[04:12:37.767] Received PubSub notification, asking Buildbucket for the build status
[04:12:37.909] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:00.591] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:3:0)
[04:13:00.591] Timer tick, asking Buildbucket for the build status
[04:13:00.808] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:13:00.808] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:5:0) after 1m0s
[04:14:00.882] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:5:0)
[04:14:00.882] Timer tick, asking Buildbucket for the build status
[04:14:01.102] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:14:01.102] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:6:0) after 1m0s
[04:15:01.105] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:6:0)
[04:15:01.105] Timer tick, asking Buildbucket for the build status
[04:15:01.341] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:15:01.341] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:7:0) after 1m0s
[04:16:01.361] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:7:0)
[04:16:01.361] Timer tick, asking Buildbucket for the build status
[04:16:01.406] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:16:01.406] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:8:0) after 1m0s
[04:17:01.466] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:8:0)
[04:17:01.466] Timer tick, asking Buildbucket for the build status
[04:17:01.626] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:17:01.626] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:9:0) after 1m0s
[04:18:01.643] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:9:0)
[04:18:01.643] Timer tick, asking Buildbucket for the build status
[04:18:01.725] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:18:01.725] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:10:0) after 1m0s
[04:19:01.740] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:10:0)
[04:19:01.740] Timer tick, asking Buildbucket for the build status
[04:19:01.806] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:19:01.806] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:11:0) after 1m0s
[04:20:01.824] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:11:0)
[04:20:01.824] Timer tick, asking Buildbucket for the build status
[04:20:02.211] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:20:02.211] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:12:0) after 1m0s
[04:21:02.203] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:12:0)
[04:21:02.203] Timer tick, asking Buildbucket for the build status
[04:21:02.369] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:21:02.369] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:13:0) after 1m0s
[04:22:02.384] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:13:0)
[04:22:02.384] Timer tick, asking Buildbucket for the build status
[04:22:02.468] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:22:02.468] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:14:0) after 1m0s
[04:23:02.496] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:14:0)
[04:23:02.496] Timer tick, asking Buildbucket for the build status
[04:23:02.719] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:23:02.719] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:15:0) after 1m0s
[04:24:02.738] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:15:0)
[04:24:02.738] Timer tick, asking Buildbucket for the build status
[04:24:03.110] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:24:03.110] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:16:0) after 1m0s
[04:25:03.135] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:16:0)
[04:25:03.135] Timer tick, asking Buildbucket for the build status
[04:25:03.511] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:25:03.511] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:17:0) after 1m0s
[04:26:03.491] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:17:0)
[04:26:03.491] Timer tick, asking Buildbucket for the build status
[04:26:03.588] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:26:03.588] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:18:0) after 1m0s
[04:27:03.614] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:18:0)
[04:27:03.614] Timer tick, asking Buildbucket for the build status
[04:27:03.679] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:27:03.679] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:19:0) after 1m0s
[04:28:03.696] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:19:0)
[04:28:03.696] Timer tick, asking Buildbucket for the build status
[04:28:04.131] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:28:04.131] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:20:0) after 1m0s
[04:29:04.151] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:20:0)
[04:29:04.151] Timer tick, asking Buildbucket for the build status
[04:29:04.225] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:29:04.225] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:21:0) after 1m0s
[04:30:04.243] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:21:0)
[04:30:04.243] Timer tick, asking Buildbucket for the build status
[04:30:05.215] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:30:05.215] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:22:0) after 1m0s
[04:31:05.233] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:22:0)
[04:31:05.233] Timer tick, asking Buildbucket for the build status
[04:31:05.408] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:31:05.408] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:23:0) after 1m0s
[04:32:05.428] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:23:0)
[04:32:05.429] Timer tick, asking Buildbucket for the build status
[04:32:05.515] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:32:05.515] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:24:0) after 1m0s
[04:33:05.507] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:24:0)
[04:33:05.507] Timer tick, asking Buildbucket for the build status
[04:33:05.671] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:33:05.671] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:25:0) after 1m0s
[04:34:05.694] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:25:0)
[04:34:05.694] Timer tick, asking Buildbucket for the build status
[04:34:05.784] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:34:05.784] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:26:0) after 1m0s
[04:35:05.810] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:26:0)
[04:35:05.810] Timer tick, asking Buildbucket for the build status
[04:35:05.938] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:35:05.938] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:27:0) after 1m0s
[04:36:05.955] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:27:0)
[04:36:05.955] Timer tick, asking Buildbucket for the build status
[04:36:06.063] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:36:06.063] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:28:0) after 1m0s
[04:37:06.042] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:28:0)
[04:37:06.042] Timer tick, asking Buildbucket for the build status
[04:37:06.109] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:37:06.109] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:29:0) after 1m0s
[04:38:06.105] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:29:0)
[04:38:06.105] Timer tick, asking Buildbucket for the build status
[04:38:06.142] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:38:06.142] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:30:0) after 1m0s
[04:39:06.163] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:30:0)
[04:39:06.163] Timer tick, asking Buildbucket for the build status
[04:39:06.264] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:39:06.264] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:31:0) after 1m0s
[04:40:06.281] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:31:0)
[04:40:06.281] Timer tick, asking Buildbucket for the build status
[04:40:06.885] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:40:06.885] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:32:0) after 1m0s
[04:41:06.904] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:32:0)
[04:41:06.904] Timer tick, asking Buildbucket for the build status
[04:41:07.067] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:41:07.067] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:33:0) after 1m0s
[04:42:07.057] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:33:0)
[04:42:07.057] Timer tick, asking Buildbucket for the build status
[04:42:07.126] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:42:07.126] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:34:0) after 1m0s
[04:43:07.144] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:34:0)
[04:43:07.144] Timer tick, asking Buildbucket for the build status
[04:43:07.458] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:43:07.458] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:35:0) after 1m0s
[04:44:07.437] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:35:0)
[04:44:07.437] Timer tick, asking Buildbucket for the build status
[04:44:07.588] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:44:07.588] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:36:0) after 1m0s
[04:45:07.607] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:36:0)
[04:45:07.608] Timer tick, asking Buildbucket for the build status
[04:45:11.950] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:45:11.950] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:37:0) after 1m0s
[04:46:11.941] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:37:0)
[04:46:11.941] Timer tick, asking Buildbucket for the build status
[04:46:12.040] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:46:12.040] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:38:0) after 1m0s
[04:47:12.064] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:38:0)
[04:47:12.064] Timer tick, asking Buildbucket for the build status
[04:47:12.217] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:47:12.217] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:39:0) after 1m0s
[04:48:12.229] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:39:0)
[04:48:12.229] Timer tick, asking Buildbucket for the build status
[04:48:12.274] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:48:12.274] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:40:0) after 1m0s
[04:49:12.243] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:40:0)
[04:49:12.243] Timer tick, asking Buildbucket for the build status
[04:49:12.344] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:49:12.344] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:41:0) after 1m0s
[04:50:12.331] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:41:0)
[04:50:12.331] Timer tick, asking Buildbucket for the build status
[04:50:12.795] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:50:12.795] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:42:0) after 1m0s
[04:51:12.903] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:42:0)
[04:51:12.903] Timer tick, asking Buildbucket for the build status
[04:51:12.985] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:51:12.985] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:43:0) after 1m0s
[04:52:13.047] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:43:0)
[04:52:13.047] Timer tick, asking Buildbucket for the build status
[04:52:13.107] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:52:13.107] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:44:0) after 1m0s
[04:53:13.129] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:44:0)
[04:53:13.129] Timer tick, asking Buildbucket for the build status
[04:53:13.361] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:53:13.361] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:45:0) after 1m0s
[04:54:13.391] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:45:0)
[04:54:13.391] Timer tick, asking Buildbucket for the build status
[04:54:13.914] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:54:13.914] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:46:0) after 1m0s
[04:55:13.907] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:46:0)
[04:55:13.907] Timer tick, asking Buildbucket for the build status
[04:55:14.085] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:55:14.085] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:47:0) after 1m0s
[04:56:14.109] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:47:0)
[04:56:14.109] Timer tick, asking Buildbucket for the build status
[04:56:14.262] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:56:14.262] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:48:0) after 1m0s
[04:57:14.287] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:48:0)
[04:57:14.287] Timer tick, asking Buildbucket for the build status
[04:57:14.329] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:57:14.329] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:49:0) after 1m0s
[04:58:14.349] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:49:0)
[04:58:14.349] Timer tick, asking Buildbucket for the build status
[04:58:14.423] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:58:14.423] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:50:0) after 1m0s
[04:59:14.444] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:50:0)
[04:59:14.444] Timer tick, asking Buildbucket for the build status
[04:59:14.625] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[04:59:14.625] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:51:0) after 1m0s
[05:00:14.646] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:51:0)
[05:00:14.646] Timer tick, asking Buildbucket for the build status
[05:00:14.783] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:00:14.783] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:52:0) after 1m0s
[05:01:14.818] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:52:0)
[05:01:14.818] Timer tick, asking Buildbucket for the build status
[05:01:14.898] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:01:14.898] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:53:0) after 1m0s
[05:02:14.917] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:53:0)
[05:02:14.917] Timer tick, asking Buildbucket for the build status
[05:02:15.048] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:02:15.048] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:54:0) after 1m0s
[05:03:15.075] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:54:0)
[05:03:15.075] Timer tick, asking Buildbucket for the build status
[05:03:15.212] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:03:15.212] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:55:0) after 1m0s
[05:04:15.229] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:55:0)
[05:04:15.229] Timer tick, asking Buildbucket for the build status
[05:04:15.319] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:04:15.319] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:56:0) after 1m0s
[05:05:15.340] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:56:0)
[05:05:15.340] Timer tick, asking Buildbucket for the build status
[05:05:15.610] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:05:15.610] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:57:0) after 1m0s
[05:06:15.603] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:57:0)
[05:06:15.603] Timer tick, asking Buildbucket for the build status
[05:06:15.715] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:06:15.715] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:58:0) after 1m0s
[05:07:15.734] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:58:0)
[05:07:15.734] Timer tick, asking Buildbucket for the build status
[05:07:15.806] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:07:15.806] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:59:0) after 1m0s
[05:08:15.823] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:59:0)
[05:08:15.823] Timer tick, asking Buildbucket for the build status
[05:08:16.074] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:08:16.074] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:60:0) after 1m0s
[05:09:16.107] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:60:0)
[05:09:16.107] Timer tick, asking Buildbucket for the build status
[05:09:16.200] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:09:16.200] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:61:0) after 1m0s
[05:10:16.219] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:61:0)
[05:10:16.219] Timer tick, asking Buildbucket for the build status
[05:10:16.275] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:10:16.275] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:62:0) after 1m0s
[05:11:16.274] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:62:0)
[05:11:16.274] Timer tick, asking Buildbucket for the build status
[05:11:16.395] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:11:16.395] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:63:0) after 1m0s
[05:12:16.382] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:63:0)
[05:12:16.382] Timer tick, asking Buildbucket for the build status
[05:12:16.449] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:12:16.449] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:64:0) after 1m0s
[05:13:16.467] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:64:0)
[05:13:16.467] Timer tick, asking Buildbucket for the build status
[05:13:16.545] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:13:16.545] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:65:0) after 1m0s
[05:14:16.564] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:65:0)
[05:14:16.564] Timer tick, asking Buildbucket for the build status
[05:14:16.619] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:14:16.619] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:66:0) after 1m0s
[05:15:16.637] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:66:0)
[05:15:16.637] Timer tick, asking Buildbucket for the build status
[05:15:16.934] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:15:16.934] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:67:0) after 1m0s
[05:16:16.951] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:67:0)
[05:16:16.951] Timer tick, asking Buildbucket for the build status
[05:16:17.015] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:16:17.015] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:68:0) after 1m0s
[05:17:17.037] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:68:0)
[05:17:17.037] Timer tick, asking Buildbucket for the build status
[05:17:17.097] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:17:17.097] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:69:0) after 1m0s
[05:18:17.084] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:69:0)
[05:18:17.084] Timer tick, asking Buildbucket for the build status
[05:18:17.571] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:18:17.571] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:70:0) after 1m0s
[05:19:17.593] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:70:0)
[05:19:17.593] Timer tick, asking Buildbucket for the build status
[05:19:17.656] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:19:17.656] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:71:0) after 1m0s
[05:20:17.674] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:71:0)
[05:20:17.674] Timer tick, asking Buildbucket for the build status
[05:20:17.977] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:20:17.977] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:72:0) after 1m0s
[05:21:18.009] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:72:0)
[05:21:18.009] Timer tick, asking Buildbucket for the build status
[05:21:18.080] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:21:18.080] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:73:0) after 1m0s
[05:22:18.099] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:73:0)
[05:22:18.099] Timer tick, asking Buildbucket for the build status
[05:22:18.169] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:22:18.169] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:74:0) after 1m0s
[05:23:18.193] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:74:0)
[05:23:18.193] Timer tick, asking Buildbucket for the build status
[05:23:18.700] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:23:18.700] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:75:0) after 1m0s
[05:24:18.687] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:75:0)
[05:24:18.687] Timer tick, asking Buildbucket for the build status
[05:24:18.787] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:24:18.787] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:76:0) after 1m0s
[05:25:18.817] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:76:0)
[05:25:18.817] Timer tick, asking Buildbucket for the build status
[05:25:18.981] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:25:18.981] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:77:0) after 1m0s
[05:26:19.001] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:77:0)
[05:26:19.001] Timer tick, asking Buildbucket for the build status
[05:26:19.065] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:26:19.065] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:78:0) after 1m0s
[05:27:19.089] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:78:0)
[05:27:19.089] Timer tick, asking Buildbucket for the build status
[05:27:19.336] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:27:19.336] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:79:0) after 1m0s
[05:28:19.310] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:79:0)
[05:28:19.310] Timer tick, asking Buildbucket for the build status
[05:28:19.550] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:28:19.550] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:80:0) after 1m0s
[05:29:19.574] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:80:0)
[05:29:19.574] Timer tick, asking Buildbucket for the build status
[05:29:19.921] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:29:19.921] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:81:0) after 1m0s
[05:30:19.942] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:81:0)
[05:30:19.942] Timer tick, asking Buildbucket for the build status
[05:30:20.017] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:30:20.017] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:82:0) after 1m0s
[05:31:20.080] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:82:0)
[05:31:20.080] Timer tick, asking Buildbucket for the build status
[05:31:20.200] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:31:20.200] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:83:0) after 1m0s
[05:32:20.219] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:83:0)
[05:32:20.219] Timer tick, asking Buildbucket for the build status
[05:32:20.281] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:32:20.281] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:84:0) after 1m0s
[05:33:20.306] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:84:0)
[05:33:20.306] Timer tick, asking Buildbucket for the build status
[05:33:20.398] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:33:20.398] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:85:0) after 1m0s
[05:34:20.421] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:85:0)
[05:34:20.421] Timer tick, asking Buildbucket for the build status
[05:34:20.484] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:34:20.485] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:86:0) after 1m0s
[05:35:20.504] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:86:0)
[05:35:20.504] Timer tick, asking Buildbucket for the build status
[05:35:20.612] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:35:20.612] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:87:0) after 1m0s
[05:36:20.631] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:87:0)
[05:36:20.631] Timer tick, asking Buildbucket for the build status
[05:36:20.720] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:36:20.720] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:88:0) after 1m0s
[05:37:20.746] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:88:0)
[05:37:20.746] Timer tick, asking Buildbucket for the build status
[05:37:20.810] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:37:20.810] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:89:0) after 1m0s
[05:38:20.832] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:89:0)
[05:38:20.832] Timer tick, asking Buildbucket for the build status
[05:38:20.891] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:38:20.891] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:90:0) after 1m0s
[05:39:20.899] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:90:0)
[05:39:20.899] Timer tick, asking Buildbucket for the build status
[05:39:21.014] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:39:21.014] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:91:0) after 1m0s
[05:40:21.034] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:91:0)
[05:40:21.034] Timer tick, asking Buildbucket for the build status
[05:40:21.454] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:40:21.454] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:92:0) after 1m0s
[05:41:21.478] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:92:0)
[05:41:21.478] Timer tick, asking Buildbucket for the build status
[05:41:21.601] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:41:21.601] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:93:0) after 1m0s
[05:42:21.617] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:93:0)
[05:42:21.617] Timer tick, asking Buildbucket for the build status
[05:42:21.713] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:42:21.713] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:94:0) after 1m0s
[05:43:21.734] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:94:0)
[05:43:21.734] Timer tick, asking Buildbucket for the build status
[05:43:21.985] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:43:21.985] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:95:0) after 1m0s
[05:44:22.002] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:95:0)
[05:44:22.002] Timer tick, asking Buildbucket for the build status
[05:44:22.121] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:44:22.121] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:96:0) after 1m0s
[05:45:22.146] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:96:0)
[05:45:22.146] Timer tick, asking Buildbucket for the build status
[05:45:22.279] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:45:22.279] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:97:0) after 1m0s
[05:46:22.305] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:97:0)
[05:46:22.305] Timer tick, asking Buildbucket for the build status
[05:46:22.495] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:46:22.495] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:98:0) after 1m0s
[05:47:22.515] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:98:0)
[05:47:22.515] Timer tick, asking Buildbucket for the build status
[05:47:22.761] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:47:22.761] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:99:0) after 1m0s
[05:48:22.782] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:99:0)
[05:48:22.782] Timer tick, asking Buildbucket for the build status
[05:48:22.926] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:48:22.926] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:100:0) after 1m0s
[05:49:22.948] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:100:0)
[05:49:22.948] Timer tick, asking Buildbucket for the build status
[05:49:23.022] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:49:23.022] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:101:0) after 1m0s
[05:50:23.041] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:101:0)
[05:50:23.041] Timer tick, asking Buildbucket for the build status
[05:50:23.210] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:50:23.210] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:102:0) after 1m0s
[05:51:23.233] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:102:0)
[05:51:23.233] Timer tick, asking Buildbucket for the build status
[05:51:23.366] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:51:23.366] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:103:0) after 1m0s
[05:52:23.395] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:103:0)
[05:52:23.395] Timer tick, asking Buildbucket for the build status
[05:52:23.574] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:52:23.574] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:104:0) after 1m0s
[05:53:23.594] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:104:0)
[05:53:23.594] Timer tick, asking Buildbucket for the build status
[05:53:23.655] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:53:23.655] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:105:0) after 1m0s
[05:54:23.678] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:105:0)
[05:54:23.678] Timer tick, asking Buildbucket for the build status
[05:54:23.865] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:54:23.865] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:106:0) after 1m0s
[05:55:23.885] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:106:0)
[05:55:23.885] Timer tick, asking Buildbucket for the build status
[05:55:23.979] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:55:23.979] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:107:0) after 1m0s
[05:56:23.994] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:107:0)
[05:56:23.994] Timer tick, asking Buildbucket for the build status
[05:56:24.103] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:56:24.103] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:108:0) after 1m0s
[05:57:24.123] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:108:0)
[05:57:24.123] Timer tick, asking Buildbucket for the build status
[05:57:24.200] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:57:24.200] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:109:0) after 1m0s
[05:58:24.223] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:109:0)
[05:58:24.223] Timer tick, asking Buildbucket for the build status
[05:58:24.300] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:58:24.300] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:110:0) after 1m0s
[05:59:24.311] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:110:0)
[05:59:24.311] Timer tick, asking Buildbucket for the build status
[05:59:24.593] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[05:59:24.593] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:111:0) after 1m0s
[06:00:24.622] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:111:0)
[06:00:24.622] Timer tick, asking Buildbucket for the build status
[06:00:24.672] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:00:24.672] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:112:0) after 1m0s
[06:01:24.703] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:112:0)
[06:01:24.703] Timer tick, asking Buildbucket for the build status
[06:01:24.875] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:01:24.875] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:113:0) after 1m0s
[06:02:24.902] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:113:0)
[06:02:24.902] Timer tick, asking Buildbucket for the build status
[06:02:25.064] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:02:25.064] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:114:0) after 1m0s
[06:03:25.060] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:114:0)
[06:03:25.060] Timer tick, asking Buildbucket for the build status
[06:03:25.370] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:03:25.370] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:115:0) after 1m0s
[06:04:25.377] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:115:0)
[06:04:25.377] Timer tick, asking Buildbucket for the build status
[06:04:25.680] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:04:25.680] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:116:0) after 1m0s
[06:05:25.669] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:116:0)
[06:05:25.669] Timer tick, asking Buildbucket for the build status
[06:05:25.749] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:05:25.749] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:117:0) after 1m0s
[06:06:25.745] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:117:0)
[06:06:25.745] Timer tick, asking Buildbucket for the build status
[06:06:25.814] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:06:25.814] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:118:0) after 1m0s
[06:07:25.836] Handling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:118:0)
[06:07:25.836] Timer tick, asking Buildbucket for the build status
[06:07:25.931] Build 8917410290083514128: status "STARTED", result "", failure_reason "", cancelation_reason ""
[06:07:25.931] Scheduling timer "check-buildbucket-build-status" (infra/codesearch-gen-chromium-win:9082840352053364000:119:0) after 1m0s
[06:07:36.716] Received PubSub notification, asking Buildbucket for the build status
[06:07:36.900] Build 8917410290083514128: status "COMPLETED", result "FAILURE", failure_reason "BUILD_FAILURE", cancelation_reason ""
[06:07:36.900] Buildbucket build:
{
"build": {
"bucket": "luci.infra.codesearch",
"canary_preference": "AUTO",
"completed_ts": "1554098855906465",
"created_by": "project:infra",
"created_ts": "1554091859698805",
"failure_reason": "BUILD_FAILURE",
"id": "8917410290083514128",
"parameters_json": "{\"builder_name\": \"codesearch-gen-chromium-win\", \"properties\": {\"root_solution_revision\": \"e01c3e081ff3ed2a7370c68091a1d08d4a22e538\", \"root_solution_revision_timestamp\": 1554090243}}",
"project": "infra",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"Step('add kythe metadata') failed with return_code 2\"}, \"properties\": {\"$recipe_engine/path\": {\"cache_dir\": \"C:\\\\b\\\\swarming\\\\w\\\\ir\\\\cache\", \"temp_dir\": \"C:\\\\b\\\\swarming\\\\w\\\\ir\\\\tmp\\\\rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"bot_id\": \"swarm2223-c4\", \"buildername\": \"codesearch-gen-chromium-win\", \"buildnumber\": 3447, \"got_angle_revision\": \"3115a0fc17fa8fb5af2490c58946de708dc17a17\", \"got_clang_revision\": \"356356-3\", \"got_dawn_revision\": \"10c24684ab9cd1c747e251d7cb4590c43eecad6b\", \"got_nacl_revision\": \"de8da4841bc3d1ed020d798d5a7fd6fb3d817fa1\", \"got_revision\": \"e01c3e081ff3ed2a7370c68091a1d08d4a22e538\", \"got_revision_cp\": \"refs/heads/master@{#646183}\", \"got_swarming_client_revision\": \"aa60736aded9fc32a0e21a81f5fc51f6009d01f3\", \"got_v8_revision\": \"804cfc5fb2ab8c49facc7a5f486c1555c2cbad63\", \"got_v8_revision_cp\": \"refs/heads/7.5.149@{#1}\", \"got_webrtc_revision\": \"708eccc1bd2d0163e35df9605649e6cadd68f589\", \"got_webrtc_revision_cp\": \"refs/heads/master@{#27374}\", \"mastername\": \"chromium.infra.codesearch\", \"path_config\": \"generic\", \"recipe\": \"chromium_codesearch\", \"root_solution_revision\": \"e01c3e081ff3ed2a7370c68091a1d08d4a22e538\", \"root_solution_revision_timestamp\": 1554090243.0}, \"swarming\": {\"bot_dimensions\": {\"builder\": [\"codesearch-gen-chromium-win\"], \"caches\": [\"builder_51272234846e6a2cd04aa26557e39158e034c42367eea2a83e543ed93811995b_v2\", \"codesearch_git_genfiles_repo\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\"], \"gce\": [\"1\"], \"gpu\": [\"none\"], \"id\": [\"swarm2223-c4\"], \"image\": [\"chrome-win10-1703-2018-04-20-61acaf8983f\"], \"integrity\": [\"high\"], \"locale\": [\"en_US.cp1252\"], \"machine_type\": [\"n1-standard-8\"], \"os\": [\"Windows\", \"Windows-10\", \"Windows-10-15063\"], \"pool\": [\"luci.infra.codesearch\"], \"python\": [\"2.7.6\"], \"server_version\": [\"4226-cfe6277\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-c\"]}}, \"ui\": {\"info\": \"Step('add kythe metadata') failed with return_code 2\"}}",
"service_account": "infra-codesearch@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1554091957279113",
"status": "COMPLETED",
"status_changed_ts": "1554091957582401",
"tags": [
"build_address:luci.infra.codesearch/codesearch-gen-chromium-win/3447",
"builder:codesearch-gen-chromium-win",
"parent_buildername:codesearch-gen-chromium-initiator",
"parent_buildnumber:8076",
"scheduler_invocation_id:9082840352053364000",
"scheduler_job_id:infra/codesearch-gen-chromium-win",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/infra/buildbucket/cr-buildbucket.appspot.com/8917410290083514128/+/annotations",
"swarming_tag:luci_project:infra",
"swarming_tag:os:Windows",
"swarming_tag:recipe_name:chromium_codesearch",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_task_id:43efe96982b5d410",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1554098856119567",
"url": "https://ci.chromium.org/b/8917410290083514128",
"utcnow_ts": "1554098856825410"
}
}
[06:07:36.900] Invocation finished in 1h56m38.463887819s with status FAILED