[23:24:56.247] New invocation is queued and will start shortly
[23:24:57.387] Starting the invocation (attempt 1)
[23:24:57.425] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/0a3b2bee79a6dc8ba290fc067d2d00acaa9181ec"
[23:24:57.425] Popped gitiles commit info from properties and tags
[23:24:57.425] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:24:57.425] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:24:57.425] Buildbucket request:
{
"requestId": "8956475579798700576",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Libfuzzer Upload Linux ASan Debug"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "0a3b2bee79a6dc8ba290fc067d2d00acaa9181ec",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8956475579798700576"
},
{
"key": "scheduler_job_id",
"value": "chromium/Libfuzzer Upload Linux ASan Debug"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[23:24:57.888] Scheduled build:
{
"id": "8791045517825017265",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Libfuzzer Upload Linux ASan Debug"
},
"number": 132754,
"createdBy": "project:chromium",
"createTime": "2023-01-24T23:24:57.499468154Z",
"updateTime": "2023-01-24T23:24:57.499468154Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "0a3b2bee79a6dc8ba290fc067d2d00acaa9181ec",
"ref": "refs/heads/main"
}
}
}
[23:24:57.888] Task URL: https://cr-buildbucket.appspot.com/build/8791045517825017265
[23:24:57.888] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:2:0) after 4m27s
[23:27:08.620] Received PubSub notification, asking Buildbucket for the build status
[23:27:08.685] Build status: STARTED
[23:29:24.917] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:2:0)
[23:29:24.951] Build status: STARTED
[23:29:24.951] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:4:0) after 4m11s
[23:33:36.171] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:4:0)
[23:33:36.199] Build status: STARTED
[23:33:36.199] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:5:0) after 2m10s
[23:35:46.261] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:5:0)
[23:35:46.283] Build status: STARTED
[23:35:46.283] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:6:0) after 2m3s
[23:37:49.809] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:6:0)
[23:37:49.835] Build status: STARTED
[23:37:49.835] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:7:0) after 4m48s
[23:42:38.243] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:7:0)
[23:42:38.266] Build status: STARTED
[23:42:38.266] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:8:0) after 5m54s
[23:48:32.341] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:8:0)
[23:48:32.366] Build status: STARTED
[23:48:32.366] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:9:0) after 4m35s
[23:53:07.455] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:9:0)
[23:53:07.497] Build status: STARTED
[23:53:07.498] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:10:0) after 7m3s
[00:00:10.803] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:10:0)
[00:00:10.828] Build status: STARTED
[00:00:10.829] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:11:0) after 4m40s
[00:04:50.974] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:11:0)
[00:04:51.003] Build status: STARTED
[00:04:51.003] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:12:0) after 9m5s
[00:13:56.037] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:12:0)
[00:13:56.107] Build status: STARTED
[00:13:56.107] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:13:0) after 5m25s
[00:19:21.555] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:13:0)
[00:19:21.576] Build status: STARTED
[00:19:21.576] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:14:0) after 4m23s
[00:23:44.593] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:14:0)
[00:23:44.611] Build status: STARTED
[00:23:44.611] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:15:0) after 4m19s
[00:28:03.747] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:15:0)
[00:28:03.770] Build status: STARTED
[00:28:03.770] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:16:0) after 3m45s
[00:31:49.078] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:16:0)
[00:31:49.099] Build status: STARTED
[00:31:49.099] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:17:0) after 8m10s
[00:39:59.562] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:17:0)
[00:39:59.584] Build status: STARTED
[00:39:59.584] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:18:0) after 2m8s
[00:42:07.889] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:18:0)
[00:42:07.916] Build status: STARTED
[00:42:07.916] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:19:0) after 3m48s
[00:45:56.234] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:19:0)
[00:45:56.269] Build status: STARTED
[00:45:56.269] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:20:0) after 2m26s
[00:48:22.492] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:20:0)
[00:48:22.513] Build status: STARTED
[00:48:22.513] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:21:0) after 3m57s
[00:52:19.763] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:21:0)
[00:52:19.784] Build status: STARTED
[00:52:19.784] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:22:0) after 9m49s
[01:02:09.741] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:22:0)
[01:02:09.835] Build status: STARTED
[01:02:09.836] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:23:0) after 9m50s
[01:12:00.292] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:23:0)
[01:12:00.317] Build status: STARTED
[01:12:00.317] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:24:0) after 8m10s
[01:20:10.553] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:24:0)
[01:20:10.574] Build status: STARTED
[01:20:10.574] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:25:0) after 3m40s
[01:23:50.797] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:25:0)
[01:23:50.818] Build status: STARTED
[01:23:50.818] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:26:0) after 1m33s
[01:25:24.000] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:26:0)
[01:25:24.026] Build status: STARTED
[01:25:24.026] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:27:0) after 5m32s
[01:30:56.285] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:27:0)
[01:30:56.350] Build status: STARTED
[01:30:56.350] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:28:0) after 4m38s
[01:35:34.613] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:28:0)
[01:35:34.635] Build status: STARTED
[01:35:34.635] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:29:0) after 3m35s
[01:39:09.661] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:29:0)
[01:39:09.705] Build status: STARTED
[01:39:09.706] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:30:0) after 5m24s
[01:44:33.725] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:30:0)
[01:44:33.743] Build status: STARTED
[01:44:33.743] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:31:0) after 9m45s
[01:54:19.301] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:31:0)
[01:54:19.327] Build status: STARTED
[01:54:19.327] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:32:0) after 5m14s
[01:59:33.404] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:32:0)
[01:59:33.434] Build status: STARTED
[01:59:33.434] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:33:0) after 4m10s
[02:03:43.555] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:33:0)
[02:03:43.578] Build status: STARTED
[02:03:43.578] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8956475579798700576:34:0) after 3m1s
[02:04:36.295] Received PubSub notification, asking Buildbucket for the build status
[02:04:36.319] Build:
{
"id": "8791045517825017265",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Libfuzzer Upload Linux ASan Debug"
},
"number": 132754,
"createdBy": "project:chromium",
"createTime": "2023-01-24T23:24:57.499468154Z",
"startTime": "2023-01-24T23:27:08.200932Z",
"endTime": "2023-01-25T02:04:36.089035307Z",
"updateTime": "2023-01-25T02:04:36.089035307Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "0a3b2bee79a6dc8ba290fc067d2d00acaa9181ec",
"ref": "refs/heads/main"
}
}
}
[02:04:36.319] Invocation finished in 2h39m40.085610687s with status SUCCEEDED