[19:15:03.952] New invocation is queued and will start shortly
[19:15:05.092] Starting the invocation (attempt 1)
[19:15:05.119] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/93973272b2232f7e498c4d44cf881937d07b898f"
[19:15:05.119] Popped gitiles commit info from properties and tags
[19:15:05.119] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[19:15:05.119] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[19:15:05.119] Buildbucket request:
{
"requestId": "8905304014337217008",
"builder": {
"project": "chromium",
"bucket": "reclient",
"builder": "Windows Cross deterministic"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "93973272b2232f7e498c4d44cf881937d07b898f",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8905304014337217008"
},
{
"key": "scheduler_job_id",
"value": "chromium/Windows Cross deterministic"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[19:15:05.750] Scheduled build:
{
"id": "8739873952374381361",
"builder": {
"project": "chromium",
"bucket": "reclient",
"builder": "Windows Cross deterministic"
},
"number": 2505,
"createdBy": "project:chromium",
"createTime": "2024-08-11T19:15:05.200247269Z",
"updateTime": "2024-08-11T19:15:05.200247269Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "93973272b2232f7e498c4d44cf881937d07b898f",
"ref": "refs/heads/main"
}
}
}
[19:15:05.750] Task URL: https://cr-buildbucket.appspot.com/build/8739873952374381361
[19:15:05.750] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:2:0) after 7m17s
[19:15:06.664] Received PubSub notification, asking Buildbucket for the build status
[19:15:06.684] Build status: SCHEDULED
[19:22:22.768] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:2:0)
[19:22:22.788] Build status: SCHEDULED
[19:22:22.788] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:4:0) after 4m40s
[19:23:39.484] Received PubSub notification, asking Buildbucket for the build status
[19:23:39.513] Build status: STARTED
[19:27:02.941] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:4:0)
[19:27:03.035] Build status: STARTED
[19:27:03.035] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:6:0) after 5m20s
[19:32:23.002] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:6:0)
[19:32:23.021] Build status: STARTED
[19:32:23.021] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:7:0) after 1m59s
[19:34:22.043] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:7:0)
[19:34:22.071] Build status: STARTED
[19:34:22.071] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:8:0) after 6m51s
[19:41:13.088] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:8:0)
[19:41:13.111] Build status: STARTED
[19:41:13.112] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:9:0) after 5m2s
[19:46:15.130] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:9:0)
[19:46:15.152] Build status: STARTED
[19:46:15.152] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:10:0) after 2m54s
[19:49:09.186] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:10:0)
[19:49:09.205] Build status: STARTED
[19:49:09.205] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:11:0) after 4m25s
[19:53:34.240] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:11:0)
[19:53:34.271] Build status: STARTED
[19:53:34.271] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:12:0) after 6m22s
[19:59:56.373] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:12:0)
[19:59:56.391] Build status: STARTED
[19:59:56.391] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:13:0) after 8m6s
[20:08:02.417] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:13:0)
[20:08:02.441] Build status: STARTED
[20:08:02.441] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:14:0) after 7m54s
[20:15:56.466] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:14:0)
[20:15:56.488] Build status: STARTED
[20:15:56.488] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:15:0) after 6m21s
[20:22:17.509] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:15:0)
[20:22:17.524] Build status: STARTED
[20:22:17.524] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:16:0) after 1m57s
[20:24:14.589] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:16:0)
[20:24:14.607] Build status: STARTED
[20:24:14.607] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:17:0) after 5m40s
[20:29:55.066] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:17:0)
[20:29:55.085] Build status: STARTED
[20:29:55.085] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:18:0) after 3m40s
[20:33:35.359] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:18:0)
[20:33:35.427] Build status: STARTED
[20:33:35.427] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:19:0) after 4m34s
[20:38:09.445] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:19:0)
[20:38:09.465] Build status: STARTED
[20:38:09.465] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:20:0) after 6m33s
[20:44:42.520] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:20:0)
[20:44:42.592] Build status: STARTED
[20:44:42.592] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:21:0) after 9m53s
[20:54:35.635] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:21:0)
[20:54:35.653] Build status: STARTED
[20:54:35.653] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:22:0) after 2m22s
[20:56:57.673] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:22:0)
[20:56:57.700] Build status: STARTED
[20:56:57.700] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:23:0) after 9m39s
[21:06:36.779] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:23:0)
[21:06:36.826] Build status: STARTED
[21:06:36.826] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:24:0) after 2m3s
[21:08:40.047] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:24:0)
[21:08:40.097] Build status: STARTED
[21:08:40.097] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:25:0) after 6m4s
[21:14:44.128] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:25:0)
[21:14:44.147] Build status: STARTED
[21:14:44.147] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:26:0) after 5m22s
[21:20:06.163] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:26:0)
[21:20:06.194] Build status: STARTED
[21:20:06.194] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:27:0) after 1m25s
[21:21:31.230] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:27:0)
[21:21:31.261] Build status: STARTED
[21:21:31.261] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:28:0) after 2m25s
[21:23:56.292] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:28:0)
[21:23:56.310] Build status: STARTED
[21:23:56.310] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:29:0) after 6m35s
[21:30:31.417] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:29:0)
[21:30:31.467] Build status: STARTED
[21:30:31.467] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:30:0) after 9m22s
[21:39:53.483] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:30:0)
[21:39:53.505] Build status: STARTED
[21:39:53.505] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:31:0) after 5m38s
[21:45:31.521] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:31:0)
[21:45:31.549] Build status: STARTED
[21:45:31.549] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:32:0) after 6m36s
[21:52:07.605] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:32:0)
[21:52:07.624] Build status: STARTED
[21:52:07.624] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:33:0) after 4m14s
[21:56:21.993] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:33:0)
[21:56:22.010] Build status: STARTED
[21:56:22.010] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:34:0) after 7m37s
[22:03:59.797] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:34:0)
[22:03:59.843] Build status: STARTED
[22:03:59.843] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:35:0) after 1m44s
[22:05:43.897] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:35:0)
[22:05:43.921] Build status: STARTED
[22:05:43.921] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:36:0) after 8m41s
[22:14:24.940] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:36:0)
[22:14:25.010] Build status: STARTED
[22:14:25.010] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:37:0) after 8m46s
[22:23:11.028] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:37:0)
[22:23:11.049] Build status: STARTED
[22:23:11.049] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:38:0) after 9m5s
[22:32:16.161] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:38:0)
[22:32:16.184] Build status: STARTED
[22:32:16.184] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:39:0) after 5m36s
[22:37:52.208] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:39:0)
[22:37:52.239] Build status: STARTED
[22:37:52.239] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:40:0) after 2m31s
[22:40:23.373] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:40:0)
[22:40:23.390] Build status: STARTED
[22:40:23.390] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:41:0) after 8m10s
[22:48:33.564] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:41:0)
[22:48:33.595] Build status: STARTED
[22:48:33.595] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:42:0) after 1m0s
[22:49:33.707] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:42:0)
[22:49:33.725] Build status: STARTED
[22:49:33.725] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:43:0) after 4m19s
[22:53:52.887] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:43:0)
[22:53:52.913] Build status: STARTED
[22:53:52.913] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:44:0) after 1m6s
[22:54:58.940] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:44:0)
[22:54:58.960] Build status: STARTED
[22:54:58.960] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:45:0) after 4m11s
[22:59:10.212] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:45:0)
[22:59:10.394] Build status: STARTED
[22:59:10.394] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:46:0) after 4m10s
[23:03:20.439] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:46:0)
[23:03:20.477] Build status: STARTED
[23:03:20.477] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:47:0) after 3m48s
[23:07:08.493] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:47:0)
[23:07:08.511] Build status: STARTED
[23:07:08.512] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:48:0) after 2m57s
[23:10:05.530] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:48:0)
[23:10:05.595] Build status: STARTED
[23:10:05.595] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:49:0) after 9m12s
[23:19:17.756] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:49:0)
[23:19:17.794] Build status: STARTED
[23:19:17.794] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:50:0) after 5m39s
[23:24:56.816] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:50:0)
[23:24:56.834] Build status: STARTED
[23:24:56.834] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:51:0) after 3m4s
[23:28:00.859] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:51:0)
[23:28:00.905] Build status: STARTED
[23:28:00.905] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:52:0) after 8m57s
[23:36:57.956] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:52:0)
[23:36:57.976] Build status: STARTED
[23:36:57.976] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:53:0) after 9m11s
[23:46:09.045] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:53:0)
[23:46:09.069] Build status: STARTED
[23:46:09.069] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:54:0) after 6m52s
[23:53:01.207] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:54:0)
[23:53:01.228] Build status: STARTED
[23:53:01.228] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:55:0) after 2m5s
[23:55:06.245] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:55:0)
[23:55:06.262] Build status: STARTED
[23:55:06.262] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:56:0) after 5m34s
[00:00:40.555] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:56:0)
[00:00:40.575] Build status: STARTED
[00:00:40.575] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:57:0) after 9m24s
[00:10:04.727] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:57:0)
[00:10:04.753] Build status: STARTED
[00:10:04.753] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:58:0) after 8m4s
[00:18:08.891] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:58:0)
[00:18:08.908] Build status: STARTED
[00:18:08.908] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:59:0) after 1m31s
[00:19:39.934] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:59:0)
[00:19:39.954] Build status: STARTED
[00:19:39.954] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:60:0) after 6m1s
[00:25:41.204] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:60:0)
[00:25:41.226] Build status: STARTED
[00:25:41.226] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:61:0) after 5m52s
[00:31:33.254] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:61:0)
[00:31:33.275] Build status: STARTED
[00:31:33.275] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:62:0) after 4m38s
[00:36:11.304] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:62:0)
[00:36:11.337] Build status: STARTED
[00:36:11.337] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:63:0) after 9m37s
[00:45:48.360] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:63:0)
[00:45:48.377] Build status: STARTED
[00:45:48.377] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:64:0) after 3m59s
[00:49:47.529] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:64:0)
[00:49:47.546] Build status: STARTED
[00:49:47.546] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:65:0) after 6m5s
[00:55:52.656] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:65:0)
[00:55:52.677] Build status: STARTED
[00:55:52.677] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:66:0) after 9m3s
[01:04:55.777] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:66:0)
[01:04:55.796] Build status: STARTED
[01:04:55.796] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:67:0) after 7m42s
[01:12:38.103] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:67:0)
[01:12:38.127] Build status: STARTED
[01:12:38.127] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:68:0) after 8m28s
[01:21:06.360] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:68:0)
[01:21:06.413] Build status: STARTED
[01:21:06.413] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:69:0) after 1m59s
[01:23:05.431] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:69:0)
[01:23:05.447] Build status: STARTED
[01:23:05.447] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:70:0) after 2m54s
[01:25:59.744] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:70:0)
[01:25:59.766] Build status: STARTED
[01:25:59.766] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:71:0) after 8m35s
[01:34:34.845] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:71:0)
[01:34:34.862] Build status: STARTED
[01:34:34.862] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:72:0) after 2m0s
[01:36:34.833] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:72:0)
[01:36:34.855] Build status: STARTED
[01:36:34.855] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:73:0) after 2m51s
[01:39:25.991] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:73:0)
[01:39:26.016] Build status: STARTED
[01:39:26.016] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:74:0) after 1m42s
[01:41:08.015] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:74:0)
[01:41:08.034] Build status: STARTED
[01:41:08.034] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:75:0) after 7m40s
[01:48:48.354] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:75:0)
[01:48:48.375] Build status: STARTED
[01:48:48.375] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:76:0) after 5m41s
[01:54:29.451] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:76:0)
[01:54:29.468] Build status: STARTED
[01:54:29.468] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:77:0) after 5m3s
[01:59:32.608] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:77:0)
[01:59:32.626] Build status: STARTED
[01:59:32.626] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:78:0) after 5m32s
[02:05:04.706] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:78:0)
[02:05:04.730] Build status: STARTED
[02:05:04.730] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:79:0) after 5m27s
[02:10:31.754] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:79:0)
[02:10:31.775] Build status: STARTED
[02:10:31.775] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:80:0) after 4m43s
[02:15:14.798] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:80:0)
[02:15:14.826] Build status: STARTED
[02:15:14.826] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:81:0) after 8m38s
[02:23:52.850] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:81:0)
[02:23:52.870] Build status: STARTED
[02:23:52.870] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:82:0) after 7m45s
[02:31:37.891] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:82:0)
[02:31:37.918] Build status: STARTED
[02:31:37.918] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:83:0) after 1m41s
[02:33:19.011] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:83:0)
[02:33:19.053] Build status: STARTED
[02:33:19.053] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:84:0) after 8m42s
[02:42:01.091] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:84:0)
[02:42:01.107] Build status: STARTED
[02:42:01.107] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:85:0) after 1m38s
[02:43:39.265] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:85:0)
[02:43:39.301] Build status: STARTED
[02:43:39.301] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:86:0) after 9m36s
[02:53:15.325] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:86:0)
[02:53:15.343] Build status: STARTED
[02:53:15.343] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:87:0) after 1m20s
[02:54:35.501] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:87:0)
[02:54:35.528] Build status: STARTED
[02:54:35.528] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:88:0) after 9m40s
[03:04:15.647] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:88:0)
[03:04:15.682] Build status: STARTED
[03:04:15.682] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:89:0) after 8m46s
[03:13:01.723] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:89:0)
[03:13:01.748] Build status: STARTED
[03:13:01.748] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:90:0) after 1m16s
[03:14:17.766] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:90:0)
[03:14:17.814] Build status: STARTED
[03:14:17.814] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:91:0) after 9m49s
[03:24:06.871] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:91:0)
[03:24:06.962] Build status: STARTED
[03:24:06.962] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:92:0) after 2m33s
[03:26:40.183] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:92:0)
[03:26:40.422] Build status: STARTED
[03:26:40.422] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:93:0) after 1m18s
[03:27:58.551] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:93:0)
[03:27:58.577] Build status: STARTED
[03:27:58.577] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:94:0) after 2m59s
[03:30:57.596] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:94:0)
[03:30:57.644] Build status: STARTED
[03:30:57.644] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:95:0) after 5m47s
[03:36:44.666] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:95:0)
[03:36:44.714] Build status: STARTED
[03:36:44.714] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:96:0) after 7m36s
[03:44:20.731] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:96:0)
[03:44:20.759] Build status: STARTED
[03:44:20.759] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:97:0) after 8m4s
[03:52:24.800] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:97:0)
[03:52:24.821] Build status: STARTED
[03:52:24.821] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:98:0) after 6m52s
[03:59:16.930] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:98:0)
[03:59:16.949] Build status: STARTED
[03:59:16.949] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:99:0) after 8m36s
[04:07:53.072] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:99:0)
[04:07:53.114] Build status: STARTED
[04:07:53.114] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:100:0) after 9m11s
[04:17:04.135] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:100:0)
[04:17:04.161] Build status: STARTED
[04:17:04.161] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:101:0) after 6m37s
[04:23:41.182] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:101:0)
[04:23:41.201] Build status: STARTED
[04:23:41.201] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:102:0) after 1m59s
[04:25:40.218] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:102:0)
[04:25:40.246] Build status: STARTED
[04:25:40.246] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:103:0) after 3m58s
[04:29:39.903] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:103:0)
[04:29:39.920] Build status: STARTED
[04:29:39.920] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:104:0) after 4m11s
[04:33:50.945] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:104:0)
[04:33:50.968] Build status: STARTED
[04:33:50.968] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:105:0) after 2m25s
[04:36:15.994] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:105:0)
[04:36:16.026] Build status: STARTED
[04:36:16.026] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:106:0) after 3m11s
[04:39:27.361] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:106:0)
[04:39:27.379] Build status: STARTED
[04:39:27.379] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:107:0) after 8m56s
[04:48:23.545] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:107:0)
[04:48:23.602] Build status: STARTED
[04:48:23.602] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:108:0) after 5m20s
[04:53:43.747] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:108:0)
[04:53:43.765] Build status: STARTED
[04:53:43.765] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:109:0) after 3m39s
[04:57:22.785] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:109:0)
[04:57:22.804] Build status: STARTED
[04:57:22.804] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:110:0) after 9m35s
[05:06:57.826] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:110:0)
[05:06:57.861] Build status: STARTED
[05:06:57.861] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:111:0) after 1m19s
[05:08:16.936] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:111:0)
[05:08:16.959] Build status: STARTED
[05:08:16.959] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:112:0) after 7m24s
[05:15:40.999] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:112:0)
[05:15:41.022] Build status: STARTED
[05:15:41.022] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:113:0) after 2m6s
[05:17:47.076] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:113:0)
[05:17:47.108] Build status: STARTED
[05:17:47.108] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:114:0) after 3m4s
[05:20:51.283] Handling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:114:0)
[05:20:51.302] Build status: STARTED
[05:20:51.302] Scheduling timer "check-buildbucket-build-status" (chromium/Windows Cross deterministic:8905304014337217008:115:0) after 9m53s
[05:30:29.565] Received PubSub notification, asking Buildbucket for the build status
[05:30:29.586] Build:
{
"id": "8739873952374381361",
"builder": {
"project": "chromium",
"bucket": "reclient",
"builder": "Windows Cross deterministic"
},
"number": 2505,
"createdBy": "project:chromium",
"createTime": "2024-08-11T19:15:05.200247269Z",
"startTime": "2024-08-11T19:23:39.250422203Z",
"endTime": "2024-08-12T05:30:29.183456924Z",
"updateTime": "2024-08-12T05:30:29.183456924Z",
"status": "INFRA_FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "93973272b2232f7e498c4d44cf881937d07b898f",
"ref": "refs/heads/main"
}
}
}
[05:30:29.586] Invocation finished in 10h15m25.641323708s with status FAILED