[22:05:10.498] New invocation is queued and will start shortly
[22:05:11.570] Starting the invocation (attempt 1)
[22:05:11.615] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/1ebce2a7196711660eeaa7ade4abc581ea1edf75"
[22:05:11.615] Popped gitiles commit info from properties and tags
[22:05:11.615] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[22:05:11.615] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[22:05:11.615] Buildbucket request:
{
"requestId": "8986921178733283584",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "mac-code-coverage"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "1ebce2a7196711660eeaa7ade4abc581ea1edf75",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8986921178733283584"
},
{
"key": "scheduler_job_id",
"value": "chromium/mac-code-coverage"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[22:05:12.145] Scheduled build:
{
"id": "8821491116819304225",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "mac-code-coverage"
},
"number": 7216,
"createdBy": "project:chromium",
"createTime": "2022-02-22T22:05:11.691644916Z",
"updateTime": "2022-02-22T22:05:11.691644916Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "1ebce2a7196711660eeaa7ade4abc581ea1edf75",
"ref": "refs/heads/main"
}
}
}
[22:05:12.145] Task URL: https://cr-buildbucket.appspot.com/build/8821491116819304225
[22:05:12.145] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:2:0) after 5m42s
[22:10:54.214] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:2:0)
[22:10:54.233] Build status: SCHEDULED
[22:10:54.233] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:3:0) after 8m17s
[22:19:11.410] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:3:0)
[22:19:11.441] Build status: SCHEDULED
[22:19:11.441] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:4:0) after 3m18s
[22:22:29.512] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:4:0)
[22:22:29.568] Build status: SCHEDULED
[22:22:29.568] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:5:0) after 5m4s
[22:27:33.643] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:5:0)
[22:27:33.663] Build status: SCHEDULED
[22:27:33.663] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:6:0) after 2m14s
[22:29:47.692] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:6:0)
[22:29:47.756] Build status: SCHEDULED
[22:29:47.756] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:7:0) after 4m4s
[22:33:52.492] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:7:0)
[22:33:52.510] Build status: SCHEDULED
[22:33:52.510] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:8:0) after 9m57s
[22:43:49.536] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:8:0)
[22:43:49.555] Build status: SCHEDULED
[22:43:49.555] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:9:0) after 9m44s
[22:46:16.106] Received PubSub notification, asking Buildbucket for the build status
[22:46:16.133] Build status: STARTED
[22:53:33.543] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:9:0)
[22:53:33.563] Build status: STARTED
[22:53:33.563] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:11:0) after 5m34s
[22:59:07.616] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:11:0)
[22:59:07.638] Build status: STARTED
[22:59:07.638] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:12:0) after 6m9s
[23:05:17.410] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:12:0)
[23:05:17.429] Build status: STARTED
[23:05:17.429] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:13:0) after 5m7s
[23:10:24.452] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:13:0)
[23:10:24.477] Build status: STARTED
[23:10:24.477] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:14:0) after 2m47s
[23:13:11.515] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:14:0)
[23:13:11.609] Build status: STARTED
[23:13:11.609] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:15:0) after 1m59s
[23:15:10.638] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:15:0)
[23:15:10.661] Build status: STARTED
[23:15:10.661] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:16:0) after 4m34s
[23:19:44.684] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:16:0)
[23:19:44.706] Build status: STARTED
[23:19:44.706] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:17:0) after 9m36s
[23:29:20.730] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:17:0)
[23:29:20.765] Build status: STARTED
[23:29:20.765] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:18:0) after 1m28s
[23:30:48.850] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:18:0)
[23:30:48.906] Build status: STARTED
[23:30:48.906] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:19:0) after 5m26s
[23:36:14.908] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:19:0)
[23:36:14.929] Build status: STARTED
[23:36:14.929] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:20:0) after 3m3s
[23:39:17.999] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:20:0)
[23:39:18.022] Build status: STARTED
[23:39:18.022] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:21:0) after 3m2s
[23:42:20.059] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:21:0)
[23:42:20.088] Build status: STARTED
[23:42:20.088] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:22:0) after 8m11s
[23:50:31.112] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:22:0)
[23:50:31.132] Build status: STARTED
[23:50:31.132] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:23:0) after 4m44s
[23:55:15.168] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:23:0)
[23:55:15.201] Build status: STARTED
[23:55:15.201] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:24:0) after 7m22s
[00:02:37.329] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:24:0)
[00:02:37.373] Build status: STARTED
[00:02:37.374] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:25:0) after 3m53s
[00:06:30.577] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:25:0)
[00:06:30.598] Build status: STARTED
[00:06:30.598] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:26:0) after 9m7s
[00:15:37.648] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:26:0)
[00:15:37.670] Build status: STARTED
[00:15:37.670] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:27:0) after 6m3s
[00:21:40.835] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:27:0)
[00:21:40.864] Build status: STARTED
[00:21:40.864] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:28:0) after 9m47s
[00:31:27.889] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:28:0)
[00:31:28.059] Build status: STARTED
[00:31:28.059] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:29:0) after 4m6s
[00:35:34.111] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:29:0)
[00:35:34.135] Build status: STARTED
[00:35:34.135] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:30:0) after 1m9s
[00:36:43.119] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:30:0)
[00:36:43.146] Build status: STARTED
[00:36:43.146] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:31:0) after 6m42s
[00:43:25.458] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:31:0)
[00:43:25.489] Build status: STARTED
[00:43:25.489] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:32:0) after 6m13s
[00:49:38.594] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:32:0)
[00:49:38.638] Build status: STARTED
[00:49:38.638] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:33:0) after 4m44s
[00:54:22.637] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:33:0)
[00:54:22.659] Build status: STARTED
[00:54:22.659] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:34:0) after 4m29s
[00:58:51.685] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:34:0)
[00:58:51.712] Build status: STARTED
[00:58:51.712] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:35:0) after 4m34s
[01:03:26.044] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:35:0)
[01:03:26.113] Build status: STARTED
[01:03:26.113] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:36:0) after 8m40s
[01:12:06.149] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:36:0)
[01:12:06.179] Build status: STARTED
[01:12:06.179] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:37:0) after 9m58s
[01:22:04.276] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:37:0)
[01:22:04.297] Build status: STARTED
[01:22:04.297] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:38:0) after 6m9s
[01:28:13.495] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:38:0)
[01:28:13.549] Build status: STARTED
[01:28:13.549] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:39:0) after 5m5s
[01:33:18.574] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:39:0)
[01:33:18.605] Build status: STARTED
[01:33:18.605] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:40:0) after 7m30s
[01:40:48.692] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:40:0)
[01:40:48.714] Build status: STARTED
[01:40:48.714] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:41:0) after 6m6s
[01:46:54.815] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:41:0)
[01:46:54.839] Build status: STARTED
[01:46:54.839] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:42:0) after 8m26s
[01:55:20.964] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:42:0)
[01:55:20.983] Build status: STARTED
[01:55:20.983] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:43:0) after 3m31s
[01:58:52.517] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:43:0)
[01:58:52.542] Build status: STARTED
[01:58:52.542] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:44:0) after 5m6s
[02:03:58.778] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:44:0)
[02:03:58.876] Build status: STARTED
[02:03:58.876] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:45:0) after 8m14s
[02:12:13.191] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:45:0)
[02:12:13.214] Build status: STARTED
[02:12:13.214] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:46:0) after 5m47s
[02:18:00.390] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:46:0)
[02:18:00.411] Build status: STARTED
[02:18:00.411] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:47:0) after 7m14s
[02:25:14.501] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:47:0)
[02:25:14.549] Build status: STARTED
[02:25:14.549] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:48:0) after 1m33s
[02:26:47.835] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:48:0)
[02:26:47.864] Build status: STARTED
[02:26:47.864] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:49:0) after 6m45s
[02:33:32.921] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:49:0)
[02:33:32.941] Build status: STARTED
[02:33:32.941] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:50:0) after 5m36s
[02:39:09.200] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:50:0)
[02:39:09.224] Build status: STARTED
[02:39:09.224] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:51:0) after 3m39s
[02:42:48.269] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:51:0)
[02:42:48.288] Build status: STARTED
[02:42:48.288] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:52:0) after 1m9s
[02:43:57.328] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:52:0)
[02:43:57.352] Build status: STARTED
[02:43:57.352] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:53:0) after 8m26s
[02:52:23.457] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:53:0)
[02:52:23.478] Build status: STARTED
[02:52:23.478] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:54:0) after 7m32s
[02:59:55.504] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:54:0)
[02:59:55.525] Build status: STARTED
[02:59:55.525] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:55:0) after 1m20s
[03:01:15.942] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:55:0)
[03:01:15.980] Build status: STARTED
[03:01:15.980] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:56:0) after 8m8s
[03:09:24.014] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:56:0)
[03:09:24.036] Build status: STARTED
[03:09:24.036] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:57:0) after 1m58s
[03:11:22.133] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:57:0)
[03:11:22.155] Build status: STARTED
[03:11:22.155] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:58:0) after 2m38s
[03:14:00.197] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:58:0)
[03:14:00.243] Build status: STARTED
[03:14:00.243] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:59:0) after 9m59s
[03:23:59.339] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:59:0)
[03:23:59.362] Build status: STARTED
[03:23:59.362] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:60:0) after 6m8s
[03:30:07.394] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:60:0)
[03:30:07.422] Build status: STARTED
[03:30:07.422] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:61:0) after 5m55s
[03:36:02.445] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:61:0)
[03:36:02.480] Build status: STARTED
[03:36:02.480] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:62:0) after 1m0s
[03:37:02.666] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:62:0)
[03:37:02.687] Build status: STARTED
[03:37:02.687] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:63:0) after 7m7s
[03:44:09.787] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:63:0)
[03:44:09.808] Build status: STARTED
[03:44:09.808] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:64:0) after 7m43s
[03:51:52.884] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:64:0)
[03:51:52.905] Build status: STARTED
[03:51:52.905] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:65:0) after 7m13s
[03:59:05.930] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:65:0)
[03:59:05.966] Build status: STARTED
[03:59:05.966] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:66:0) after 1m43s
[04:00:48.991] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:66:0)
[04:00:49.032] Build status: STARTED
[04:00:49.032] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:67:0) after 7m12s
[04:08:01.162] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:67:0)
[04:08:01.189] Build status: STARTED
[04:08:01.189] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:68:0) after 1m8s
[04:09:09.299] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:68:0)
[04:09:09.319] Build status: STARTED
[04:09:09.319] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:69:0) after 1m40s
[04:10:49.522] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:69:0)
[04:10:49.545] Build status: STARTED
[04:10:49.545] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:70:0) after 9m20s
[04:20:09.575] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:70:0)
[04:20:09.598] Build status: STARTED
[04:20:09.598] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:71:0) after 3m52s
[04:24:01.748] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:71:0)
[04:24:01.788] Build status: STARTED
[04:24:01.788] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:72:0) after 1m23s
[04:25:24.940] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:72:0)
[04:25:24.964] Build status: STARTED
[04:25:24.964] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:73:0) after 6m42s
[04:32:06.997] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:73:0)
[04:32:07.063] Build status: STARTED
[04:32:07.063] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:74:0) after 7m40s
[04:39:47.089] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:74:0)
[04:39:47.110] Build status: STARTED
[04:39:47.110] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:75:0) after 1m24s
[04:41:11.159] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:75:0)
[04:41:11.177] Build status: STARTED
[04:41:11.177] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:76:0) after 5m10s
[04:46:21.233] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:76:0)
[04:46:21.253] Build status: STARTED
[04:46:21.253] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:77:0) after 7m0s
[04:53:21.376] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:77:0)
[04:53:21.397] Build status: STARTED
[04:53:21.397] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:78:0) after 4m45s
[04:58:06.416] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:78:0)
[04:58:06.436] Build status: STARTED
[04:58:06.436] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:79:0) after 1m17s
[04:59:23.522] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:79:0)
[04:59:23.544] Build status: STARTED
[04:59:23.544] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:80:0) after 4m13s
[05:03:36.577] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:80:0)
[05:03:36.612] Build status: STARTED
[05:03:36.612] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:81:0) after 9m43s
[05:13:19.703] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:81:0)
[05:13:19.729] Build status: STARTED
[05:13:19.729] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:82:0) after 4m50s
[05:18:09.759] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:82:0)
[05:18:09.950] Build status: STARTED
[05:18:09.950] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:83:0) after 1m53s
[05:20:03.081] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:83:0)
[05:20:03.115] Build status: STARTED
[05:20:03.115] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:84:0) after 6m1s
[05:26:04.219] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:84:0)
[05:26:04.252] Build status: STARTED
[05:26:04.252] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:85:0) after 4m20s
[05:30:24.288] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:85:0)
[05:30:24.326] Build status: STARTED
[05:30:24.326] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:86:0) after 7m52s
[05:38:16.482] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:86:0)
[05:38:16.508] Build status: STARTED
[05:38:16.508] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:87:0) after 5m45s
[05:44:01.797] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:87:0)
[05:44:01.818] Build status: STARTED
[05:44:01.818] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:88:0) after 2m39s
[05:46:40.873] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:88:0)
[05:46:40.893] Build status: STARTED
[05:46:40.893] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:89:0) after 6m20s
[05:53:00.935] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:89:0)
[05:53:00.958] Build status: STARTED
[05:53:00.958] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:90:0) after 1m4s
[05:54:04.988] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:90:0)
[05:54:05.012] Build status: STARTED
[05:54:05.012] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:91:0) after 9m14s
[06:03:19.058] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:91:0)
[06:03:19.077] Build status: STARTED
[06:03:19.077] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:92:0) after 5m36s
[06:08:55.227] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:92:0)
[06:08:55.251] Build status: STARTED
[06:08:55.252] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:93:0) after 5m15s
[06:14:10.355] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:93:0)
[06:14:10.375] Build status: STARTED
[06:14:10.375] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:94:0) after 6m41s
[06:20:51.386] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:94:0)
[06:20:51.405] Build status: STARTED
[06:20:51.405] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:95:0) after 1m48s
[06:22:39.412] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:95:0)
[06:22:39.435] Build status: STARTED
[06:22:39.435] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:96:0) after 1m56s
[06:24:35.542] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:96:0)
[06:24:35.566] Build status: STARTED
[06:24:35.566] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:97:0) after 6m13s
[06:30:48.607] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:97:0)
[06:30:48.626] Build status: STARTED
[06:30:48.626] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:98:0) after 8m55s
[06:39:43.663] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:98:0)
[06:39:43.683] Build status: STARTED
[06:39:43.683] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:99:0) after 5m0s
[06:44:43.798] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:99:0)
[06:44:43.818] Build status: STARTED
[06:44:43.818] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:100:0) after 9m19s
[06:54:02.871] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:100:0)
[06:54:02.893] Build status: STARTED
[06:54:02.893] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:101:0) after 7m37s
[07:01:40.043] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:101:0)
[07:01:40.065] Build status: STARTED
[07:01:40.065] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:102:0) after 2m30s
[07:04:10.095] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:102:0)
[07:04:10.122] Build status: STARTED
[07:04:10.122] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:103:0) after 5m29s
[07:09:39.364] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:103:0)
[07:09:39.382] Build status: STARTED
[07:09:39.382] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:104:0) after 8m55s
[07:18:34.366] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:104:0)
[07:18:34.387] Build status: STARTED
[07:18:34.387] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:105:0) after 3m43s
[07:22:17.520] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:105:0)
[07:22:17.544] Build status: STARTED
[07:22:17.544] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:106:0) after 6m15s
[07:28:32.688] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:106:0)
[07:28:32.849] Build status: STARTED
[07:28:32.849] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:107:0) after 5m8s
[07:33:40.890] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:107:0)
[07:33:40.911] Build status: STARTED
[07:33:40.911] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:108:0) after 4m30s
[07:38:10.933] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:108:0)
[07:38:10.951] Build status: STARTED
[07:38:10.951] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:109:0) after 6m42s
[07:44:52.978] Handling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:109:0)
[07:44:53.041] Build status: STARTED
[07:44:53.041] Scheduling timer "check-buildbucket-build-status" (chromium/mac-code-coverage:8986921178733283584:110:0) after 4m31s
[07:45:28.919] Received PubSub notification, asking Buildbucket for the build status
[07:45:28.943] Build:
{
"id": "8821491116819304225",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "mac-code-coverage"
},
"number": 7216,
"createdBy": "project:chromium",
"createTime": "2022-02-22T22:05:11.691644916Z",
"startTime": "2022-02-22T22:46:15.454497Z",
"endTime": "2022-02-23T07:45:28.490257880Z",
"updateTime": "2022-02-23T07:45:28.490257880Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "1ebce2a7196711660eeaa7ade4abc581ea1edf75",
"ref": "refs/heads/main"
}
}
}
[07:45:28.943] Invocation finished in 9h40m18.460627552s with status FAILED