[20:40:17.346] New invocation is queued and will start shortly
[20:40:18.422] Starting the invocation (attempt 1)
[20:40:18.449] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/2edff65eb9fdd62ee65d0eb872b049b94e78b8cd"
[20:40:18.449] Popped gitiles commit info from properties and tags
[20:40:18.449] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:40:18.449] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:40:18.449] Buildbucket request:
{
"requestId": "8946248481366488528",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Libfuzzer Upload Linux ASan Debug"
},
"properties": {
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "2edff65eb9fdd62ee65d0eb872b049b94e78b8cd",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8946248481366488528"
},
{
"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"
}
}
[20:40:19.016] Scheduled build:
{
"id": "8780818419490634353",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Libfuzzer Upload Linux ASan Debug"
},
"number": 137630,
"createdBy": "project:chromium",
"createTime": "2023-05-17T20:40:18.512778891Z",
"updateTime": "2023-05-17T20:40:18.512778891Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "2edff65eb9fdd62ee65d0eb872b049b94e78b8cd",
"ref": "refs/heads/main"
}
}
}
[20:40:19.016] Task URL: https://cr-buildbucket.appspot.com/build/8780818419490634353
[20:40:19.016] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:2:0) after 9m18s
[20:42:29.702] Received PubSub notification, asking Buildbucket for the build status
[20:42:29.718] Build status: STARTED
[20:49:37.032] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:2:0)
[20:49:37.048] Build status: STARTED
[20:49:37.048] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:4:0) after 1m51s
[20:51:28.214] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:4:0)
[20:51:28.244] Build status: STARTED
[20:51:28.244] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:5:0) after 4m57s
[20:56:25.476] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:5:0)
[20:56:25.497] Build status: STARTED
[20:56:25.497] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:6:0) after 6m58s
[21:03:23.909] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:6:0)
[21:03:23.933] Build status: STARTED
[21:03:23.933] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:7:0) after 1m40s
[21:05:04.026] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:7:0)
[21:05:04.057] Build status: STARTED
[21:05:04.057] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:8:0) after 7m54s
[21:12:58.104] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:8:0)
[21:12:58.121] Build status: STARTED
[21:12:58.121] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:9:0) after 6m8s
[21:19:06.281] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:9:0)
[21:19:06.301] Build status: STARTED
[21:19:06.301] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:10:0) after 7m18s
[21:26:24.376] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:10:0)
[21:26:24.394] Build status: STARTED
[21:26:24.394] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:11:0) after 7m35s
[21:33:59.507] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:11:0)
[21:33:59.529] Build status: STARTED
[21:33:59.529] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:12:0) after 1m38s
[21:35:37.544] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:12:0)
[21:35:37.609] Build status: STARTED
[21:35:37.609] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:13:0) after 8m34s
[21:44:11.793] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:13:0)
[21:44:11.814] Build status: STARTED
[21:44:11.814] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:14:0) after 2m8s
[21:46:20.301] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:14:0)
[21:46:20.320] Build status: STARTED
[21:46:20.320] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:15:0) after 2m47s
[21:49:07.396] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:15:0)
[21:49:07.414] Build status: STARTED
[21:49:07.414] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:16:0) after 3m34s
[21:52:41.541] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:16:0)
[21:52:41.560] Build status: STARTED
[21:52:41.560] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:17:0) after 2m17s
[21:54:58.610] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:17:0)
[21:54:58.628] Build status: STARTED
[21:54:58.628] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:18:0) after 4m57s
[21:59:55.942] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:18:0)
[21:59:55.959] Build status: STARTED
[21:59:55.959] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:19:0) after 6m23s
[22:06:19.058] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:19:0)
[22:06:19.074] Build status: STARTED
[22:06:19.074] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:20:0) after 2m25s
[22:08:44.091] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:20:0)
[22:08:44.109] Build status: STARTED
[22:08:44.109] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:21:0) after 8m59s
[22:17:43.728] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:21:0)
[22:17:43.763] Build status: STARTED
[22:17:43.763] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:22:0) after 4m4s
[22:21:47.789] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:22:0)
[22:21:47.812] Build status: STARTED
[22:21:47.812] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:23:0) after 6m20s
[22:28:07.884] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:23:0)
[22:28:07.902] Build status: STARTED
[22:28:07.902] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:24:0) after 1m38s
[22:29:46.007] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:24:0)
[22:29:46.076] Build status: STARTED
[22:29:46.076] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:25:0) after 7m21s
[22:37:07.790] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:25:0)
[22:37:07.808] Build status: STARTED
[22:37:07.808] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:26:0) after 9m29s
[22:46:37.293] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:26:0)
[22:46:37.314] Build status: STARTED
[22:46:37.314] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:27:0) after 9m30s
[22:56:07.665] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:27:0)
[22:56:07.684] Build status: STARTED
[22:56:07.684] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:28:0) after 6m41s
[23:02:48.781] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:28:0)
[23:02:48.804] Build status: STARTED
[23:02:48.804] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:29:0) after 2m2s
[23:04:50.833] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:29:0)
[23:04:50.849] Build status: STARTED
[23:04:50.850] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:30:0) after 9m33s
[23:14:23.936] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:30:0)
[23:14:23.953] Build status: STARTED
[23:14:23.953] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:31:0) after 8m31s
[23:22:55.247] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:31:0)
[23:22:55.270] Build status: STARTED
[23:22:55.270] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:32:0) after 4m32s
[23:27:27.640] Handling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:32:0)
[23:27:27.665] Build status: STARTED
[23:27:27.665] Scheduling timer "check-buildbucket-build-status" (chromium/Libfuzzer Upload Linux ASan Debug:8946248481366488528:33:0) after 9m43s
[23:30:33.109] Received PubSub notification, asking Buildbucket for the build status
[23:30:33.130] Build:
{
"id": "8780818419490634353",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Libfuzzer Upload Linux ASan Debug"
},
"number": 137630,
"createdBy": "project:chromium",
"createTime": "2023-05-17T20:40:18.512778891Z",
"startTime": "2023-05-17T20:42:28.965840Z",
"endTime": "2023-05-17T23:30:32.670451781Z",
"updateTime": "2023-05-17T23:30:32.670451781Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "2edff65eb9fdd62ee65d0eb872b049b94e78b8cd",
"ref": "refs/heads/main"
}
}
}
[23:30:33.130] Invocation finished in 2h50m15.79053074s with status SUCCEEDED