[01:30:50.861] New invocation is queued and will start shortly
[01:30:52.164] Starting the invocation (attempt 1)
[01:30:52.214] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/ac3cfdd3e961f4db164ab8de44c38c9ba34a8c1e"
[01:30:52.214] Popped gitiles commit info from properties and tags
[01:30:52.214] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[01:30:52.214] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[01:30:52.214] Buildbucket request:
{
"requestId": "8961359894440047056",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin64"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "ac3cfdd3e961f4db164ab8de44c38c9ba34a8c1e",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8961359894440047056"
},
{
"key": "scheduler_job_id",
"value": "chromium/ToTWin64"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[01:30:52.741] Scheduled build:
{
"id": "8795929832224242481",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin64"
},
"number": 2874,
"createdBy": "project:chromium",
"createTime": "2022-12-02T01:30:52.304044512Z",
"updateTime": "2022-12-02T01:30:52.304044512Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "ac3cfdd3e961f4db164ab8de44c38c9ba34a8c1e",
"ref": "refs/heads/main"
}
}
}
[01:30:52.741] Task URL: https://cr-buildbucket.appspot.com/build/8795929832224242481
[01:30:52.741] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:2:0) after 1m48s
[01:31:02.014] Received PubSub notification, asking Buildbucket for the build status
[01:31:02.047] Build status: STARTED
[01:32:40.733] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:2:0)
[01:32:40.755] Build status: STARTED
[01:32:40.755] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:4:0) after 2m53s
[01:35:33.968] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:4:0)
[01:35:34.008] Build status: STARTED
[01:35:34.008] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:5:0) after 2m19s
[01:37:53.419] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:5:0)
[01:37:53.443] Build status: STARTED
[01:37:53.443] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:6:0) after 4m55s
[01:42:48.587] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:6:0)
[01:42:48.608] Build status: STARTED
[01:42:48.608] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:7:0) after 6m30s
[01:49:18.701] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:7:0)
[01:49:18.723] Build status: STARTED
[01:49:18.723] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:8:0) after 2m49s
[01:52:07.875] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:8:0)
[01:52:07.896] Build status: STARTED
[01:52:07.896] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:9:0) after 8m15s
[02:00:23.194] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:9:0)
[02:00:23.225] Build status: STARTED
[02:00:23.225] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:10:0) after 4m32s
[02:04:55.300] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:10:0)
[02:04:55.335] Build status: STARTED
[02:04:55.335] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:11:0) after 3m2s
[02:07:57.377] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:11:0)
[02:07:57.409] Build status: STARTED
[02:07:57.409] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:12:0) after 2m10s
[02:10:07.440] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:12:0)
[02:10:07.472] Build status: STARTED
[02:10:07.472] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:13:0) after 3m36s
[02:13:43.842] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:13:0)
[02:13:43.864] Build status: STARTED
[02:13:43.864] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:14:0) after 1m56s
[02:15:40.168] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:14:0)
[02:15:40.195] Build status: STARTED
[02:15:40.195] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:15:0) after 1m41s
[02:17:21.542] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:15:0)
[02:17:21.566] Build status: STARTED
[02:17:21.566] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:16:0) after 1m49s
[02:19:10.592] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:16:0)
[02:19:10.618] Build status: STARTED
[02:19:10.618] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:17:0) after 9m24s
[02:28:34.752] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:17:0)
[02:28:34.775] Build status: STARTED
[02:28:34.775] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:18:0) after 8m58s
[02:37:32.816] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:18:0)
[02:37:32.873] Build status: STARTED
[02:37:32.873] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:19:0) after 3m3s
[02:40:35.930] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:19:0)
[02:40:35.958] Build status: STARTED
[02:40:35.958] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:20:0) after 9m12s
[02:49:47.989] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:20:0)
[02:49:48.013] Build status: STARTED
[02:49:48.013] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:21:0) after 7m15s
[02:57:03.339] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:21:0)
[02:57:03.365] Build status: STARTED
[02:57:03.365] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:22:0) after 4m15s
[03:01:18.397] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:22:0)
[03:01:18.426] Build status: STARTED
[03:01:18.426] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:23:0) after 1m57s
[03:03:15.462] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:23:0)
[03:03:15.496] Build status: STARTED
[03:03:15.496] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:24:0) after 2m29s
[03:05:44.608] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:24:0)
[03:05:44.634] Build status: STARTED
[03:05:44.634] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:25:0) after 7m47s
[03:13:31.661] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:25:0)
[03:13:31.689] Build status: STARTED
[03:13:31.690] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:26:0) after 8m51s
[03:22:22.904] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:26:0)
[03:22:22.935] Build status: STARTED
[03:22:22.935] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:27:0) after 3m47s
[03:26:10.127] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:27:0)
[03:26:10.181] Build status: STARTED
[03:26:10.181] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:28:0) after 4m45s
[03:30:55.231] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:28:0)
[03:30:55.264] Build status: STARTED
[03:30:55.264] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:29:0) after 3m45s
[03:34:40.312] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:29:0)
[03:34:40.341] Build status: STARTED
[03:34:40.341] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:30:0) after 6m40s
[03:41:20.816] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:30:0)
[03:41:20.843] Build status: STARTED
[03:41:20.843] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:31:0) after 3m12s
[03:44:32.895] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:31:0)
[03:44:32.916] Build status: STARTED
[03:44:32.916] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:32:0) after 5m6s
[03:49:38.974] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:32:0)
[03:49:39.002] Build status: STARTED
[03:49:39.002] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:33:0) after 3m16s
[03:52:55.139] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:33:0)
[03:52:55.164] Build status: STARTED
[03:52:55.164] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:34:0) after 1m26s
[03:54:21.290] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:34:0)
[03:54:21.508] Build status: STARTED
[03:54:21.508] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:35:0) after 1m39s
[03:56:00.539] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:35:0)
[03:56:00.561] Build status: STARTED
[03:56:00.561] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:36:0) after 4m31s
[04:00:31.700] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:36:0)
[04:00:31.722] Build status: STARTED
[04:00:31.722] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:37:0) after 1m24s
[04:01:55.826] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:37:0)
[04:01:55.855] Build status: STARTED
[04:01:55.855] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:38:0) after 4m17s
[04:06:12.910] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:38:0)
[04:06:12.980] Build status: STARTED
[04:06:12.980] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:39:0) after 2m31s
[04:08:44.015] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:39:0)
[04:08:44.036] Build status: STARTED
[04:08:44.036] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:40:0) after 4m38s
[04:13:22.262] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:40:0)
[04:13:22.284] Build status: STARTED
[04:13:22.284] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:41:0) after 3m48s
[04:17:10.707] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:41:0)
[04:17:10.795] Build status: STARTED
[04:17:10.795] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:42:0) after 2m7s
[04:19:17.873] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:42:0)
[04:19:17.911] Build status: STARTED
[04:19:17.911] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:43:0) after 3m25s
[04:22:43.252] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:43:0)
[04:22:43.276] Build status: STARTED
[04:22:43.276] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:44:0) after 1m46s
[04:24:29.362] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:44:0)
[04:24:29.384] Build status: STARTED
[04:24:29.384] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:45:0) after 2m33s
[04:27:02.513] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:45:0)
[04:27:02.535] Build status: STARTED
[04:27:02.535] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:46:0) after 9m53s
[04:36:55.652] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:46:0)
[04:36:55.678] Build status: STARTED
[04:36:55.678] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:47:0) after 1m39s
[04:38:34.922] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:47:0)
[04:38:34.945] Build status: STARTED
[04:38:34.946] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:48:0) after 1m54s
[04:40:29.241] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:48:0)
[04:40:29.264] Build status: STARTED
[04:40:29.265] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:49:0) after 1m20s
[04:41:49.296] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:49:0)
[04:41:49.318] Build status: STARTED
[04:41:49.318] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:50:0) after 2m28s
[04:44:17.630] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:50:0)
[04:44:17.652] Build status: STARTED
[04:44:17.652] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:51:0) after 2m0s
[04:46:17.697] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:51:0)
[04:46:17.726] Build status: STARTED
[04:46:17.726] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:52:0) after 4m18s
[04:50:35.999] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:52:0)
[04:50:36.019] Build status: STARTED
[04:50:36.019] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:53:0) after 7m58s
[04:58:34.088] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:53:0)
[04:58:34.111] Build status: STARTED
[04:58:34.111] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:54:0) after 1m51s
[05:00:25.286] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:54:0)
[05:00:25.384] Build status: STARTED
[05:00:25.384] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:55:0) after 2m31s
[05:02:56.416] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:55:0)
[05:02:56.437] Build status: STARTED
[05:02:56.437] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:56:0) after 4m44s
[05:07:40.580] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:56:0)
[05:07:40.605] Build status: STARTED
[05:07:40.605] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:57:0) after 3m21s
[05:11:01.651] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:57:0)
[05:11:01.688] Build status: STARTED
[05:11:01.688] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:58:0) after 1m30s
[05:12:31.875] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:58:0)
[05:12:31.896] Build status: STARTED
[05:12:31.896] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:59:0) after 9m58s
[05:22:30.027] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:59:0)
[05:22:30.053] Build status: STARTED
[05:22:30.053] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:60:0) after 8m28s
[05:30:58.421] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:60:0)
[05:30:58.459] Build status: STARTED
[05:30:58.459] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:61:0) after 4m39s
[05:35:37.747] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:61:0)
[05:35:37.767] Build status: STARTED
[05:35:37.767] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:62:0) after 1m0s
[05:36:37.927] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:62:0)
[05:36:37.952] Build status: STARTED
[05:36:37.952] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:63:0) after 2m44s
[05:39:21.986] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:63:0)
[05:39:22.015] Build status: STARTED
[05:39:22.015] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:64:0) after 8m1s
[05:47:23.077] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:64:0)
[05:47:23.100] Build status: STARTED
[05:47:23.100] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:65:0) after 2m14s
[05:49:37.096] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:65:0)
[05:49:37.121] Build status: STARTED
[05:49:37.121] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:66:0) after 5m40s
[05:55:17.215] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:66:0)
[05:55:17.254] Build status: STARTED
[05:55:17.254] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:67:0) after 5m28s
[06:00:45.290] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:67:0)
[06:00:45.312] Build status: STARTED
[06:00:45.312] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:68:0) after 3m56s
[06:04:41.333] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:68:0)
[06:04:41.357] Build status: STARTED
[06:04:41.357] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:69:0) after 7m1s
[06:11:42.524] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:69:0)
[06:11:42.544] Build status: STARTED
[06:11:42.545] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:70:0) after 6m20s
[06:18:02.616] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:70:0)
[06:18:02.642] Build status: STARTED
[06:18:02.642] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:71:0) after 2m38s
[06:20:40.681] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:71:0)
[06:20:40.707] Build status: STARTED
[06:20:40.707] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:72:0) after 6m31s
[06:27:11.744] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:72:0)
[06:27:11.770] Build status: STARTED
[06:27:11.770] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:73:0) after 6m52s
[06:34:03.875] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:73:0)
[06:34:03.898] Build status: STARTED
[06:34:03.898] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:74:0) after 1m22s
[06:35:25.998] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:74:0)
[06:35:26.057] Build status: STARTED
[06:35:26.058] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:75:0) after 3m57s
[06:39:23.091] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:75:0)
[06:39:23.119] Build status: STARTED
[06:39:23.119] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:76:0) after 6m59s
[06:46:22.513] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:76:0)
[06:46:22.576] Build status: STARTED
[06:46:22.577] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:77:0) after 9m8s
[06:55:38.994] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:77:0)
[06:55:39.021] Build status: STARTED
[06:55:39.022] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:78:0) after 5m19s
[07:00:58.337] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:78:0)
[07:00:58.365] Build status: STARTED
[07:00:58.365] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:79:0) after 8m36s
[07:09:34.395] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:79:0)
[07:09:34.425] Build status: STARTED
[07:09:34.425] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:80:0) after 7m41s
[07:17:15.533] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:80:0)
[07:17:15.561] Build status: STARTED
[07:17:15.561] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:81:0) after 9m57s
[07:27:12.611] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:81:0)
[07:27:12.639] Build status: STARTED
[07:27:12.639] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:82:0) after 8m6s
[07:35:18.827] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:82:0)
[07:35:18.861] Build status: STARTED
[07:35:18.861] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:83:0) after 3m42s
[07:39:00.888] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:83:0)
[07:39:00.925] Build status: STARTED
[07:39:00.925] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:84:0) after 1m51s
[07:40:52.160] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:84:0)
[07:40:52.184] Build status: STARTED
[07:40:52.184] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:85:0) after 7m22s
[07:48:14.339] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:85:0)
[07:48:14.364] Build status: STARTED
[07:48:14.364] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:86:0) after 4m29s
[07:52:43.439] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:86:0)
[07:52:43.461] Build status: STARTED
[07:52:43.461] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:87:0) after 5m46s
[07:58:29.589] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:87:0)
[07:58:29.610] Build status: STARTED
[07:58:29.610] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:88:0) after 5m55s
[08:04:24.843] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:88:0)
[08:04:24.866] Build status: STARTED
[08:04:24.866] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:89:0) after 8m28s
[08:12:52.877] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:89:0)
[08:12:52.899] Build status: STARTED
[08:12:52.899] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:90:0) after 8m10s
[08:21:03.117] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:90:0)
[08:21:03.154] Build status: STARTED
[08:21:03.154] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:91:0) after 3m28s
[08:24:31.203] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:91:0)
[08:24:31.238] Build status: STARTED
[08:24:31.238] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:92:0) after 5m4s
[08:29:35.471] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:92:0)
[08:29:35.494] Build status: STARTED
[08:29:35.494] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:93:0) after 7m40s
[08:37:15.522] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:93:0)
[08:37:15.545] Build status: STARTED
[08:37:15.545] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:94:0) after 4m51s
[08:42:06.675] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:94:0)
[08:42:06.700] Build status: STARTED
[08:42:06.700] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:95:0) after 7m11s
[08:49:18.064] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:95:0)
[08:49:18.089] Build status: STARTED
[08:49:18.089] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:96:0) after 5m36s
[08:54:54.190] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:96:0)
[08:54:54.214] Build status: STARTED
[08:54:54.214] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:97:0) after 2m12s
[08:57:06.260] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:97:0)
[08:57:06.319] Build status: STARTED
[08:57:06.319] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:98:0) after 1m1s
[08:58:07.355] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:98:0)
[08:58:07.403] Build status: STARTED
[08:58:07.403] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:99:0) after 8m52s
[09:06:59.519] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:99:0)
[09:06:59.540] Build status: STARTED
[09:06:59.540] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:100:0) after 8m29s
[09:15:28.587] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:100:0)
[09:15:28.773] Build status: STARTED
[09:15:28.773] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:101:0) after 6m42s
[09:22:10.819] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:101:0)
[09:22:10.843] Build status: STARTED
[09:22:10.843] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:102:0) after 8m47s
[09:30:57.967] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:102:0)
[09:30:57.995] Build status: STARTED
[09:30:57.995] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:103:0) after 7m15s
[09:38:13.102] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:103:0)
[09:38:13.124] Build status: STARTED
[09:38:13.124] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:104:0) after 5m41s
[09:43:54.322] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:104:0)
[09:43:54.341] Build status: STARTED
[09:43:54.341] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:105:0) after 5m40s
[09:49:34.390] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:105:0)
[09:49:34.412] Build status: STARTED
[09:49:34.412] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:106:0) after 6m0s
[09:55:34.468] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:106:0)
[09:55:34.493] Build status: STARTED
[09:55:34.493] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:107:0) after 5m20s
[10:00:54.576] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:107:0)
[10:00:54.602] Build status: STARTED
[10:00:54.602] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:108:0) after 5m27s
[10:06:21.828] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:108:0)
[10:06:21.853] Build status: STARTED
[10:06:21.853] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:109:0) after 9m58s
[10:16:19.968] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:109:0)
[10:16:19.991] Build status: STARTED
[10:16:19.991] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:110:0) after 8m43s
[10:25:03.018] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:110:0)
[10:25:03.041] Build status: STARTED
[10:25:03.041] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:111:0) after 3m13s
[10:28:16.197] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:111:0)
[10:28:16.218] Build status: STARTED
[10:28:16.218] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:112:0) after 3m36s
[10:31:52.238] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:112:0)
[10:31:52.305] Build status: STARTED
[10:31:52.305] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:113:0) after 5m11s
[10:37:03.342] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:113:0)
[10:37:03.365] Build status: STARTED
[10:37:03.365] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:114:0) after 2m57s
[10:40:00.550] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:114:0)
[10:40:00.720] Build status: STARTED
[10:40:00.720] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:115:0) after 4m22s
[10:44:22.933] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:115:0)
[10:44:22.958] Build status: STARTED
[10:44:22.958] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:116:0) after 3m1s
[10:47:24.219] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:116:0)
[10:47:24.241] Build status: STARTED
[10:47:24.241] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:117:0) after 7m1s
[10:54:25.394] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:117:0)
[10:54:25.420] Build status: STARTED
[10:54:25.420] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:118:0) after 9m32s
[11:03:57.550] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:118:0)
[11:03:57.570] Build status: STARTED
[11:03:57.570] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:119:0) after 7m24s
[11:11:21.656] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:119:0)
[11:11:21.681] Build status: STARTED
[11:11:21.681] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:120:0) after 8m14s
[11:19:35.837] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:120:0)
[11:19:35.858] Build status: STARTED
[11:19:35.858] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:121:0) after 1m14s
[11:20:49.911] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:121:0)
[11:20:49.938] Build status: STARTED
[11:20:49.938] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:122:0) after 6m36s
[11:27:26.546] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:122:0)
[11:27:26.572] Build status: STARTED
[11:27:26.572] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:123:0) after 4m56s
[11:32:22.677] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:123:0)
[11:32:22.817] Build status: STARTED
[11:32:22.817] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:124:0) after 3m23s
[11:35:45.848] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:124:0)
[11:35:45.869] Build status: STARTED
[11:35:45.869] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:125:0) after 1m13s
[11:36:58.938] Handling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:125:0)
[11:36:58.963] Build status: STARTED
[11:36:58.963] Scheduling timer "check-buildbucket-build-status" (chromium/ToTWin64:8961359894440047056:126:0) after 8m17s
[11:42:08.406] Received PubSub notification, asking Buildbucket for the build status
[11:42:08.450] Build:
{
"id": "8795929832224242481",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "ToTWin64"
},
"number": 2874,
"createdBy": "project:chromium",
"createTime": "2022-12-02T01:30:52.304044512Z",
"startTime": "2022-12-02T01:31:00.868770Z",
"endTime": "2022-12-02T11:42:08.123654741Z",
"updateTime": "2022-12-02T11:42:08.123654741Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "ac3cfdd3e961f4db164ab8de44c38c9ba34a8c1e",
"ref": "refs/heads/main"
}
}
}
[11:42:08.450] Invocation finished in 10h11m17.64299479s with status SUCCEEDED