[20:30:25.657] New invocation is queued and will start shortly
[20:30:27.062] Starting the invocation (attempt 1)
[20:30:27.101] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/5edb3e1401ef01c13e7f2dad947389e25402786d"
[20:30:27.102] Popped gitiles commit info from properties and tags
[20:30:27.102] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[20:30:27.102] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[20:30:27.102] Buildbucket request:
{
"requestId": "8938638956627055392",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8938638956627055392",
"job": "fuchsia/firebase-docs-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "98573a183a502d2ca181d82d5deb46f88deb6d56"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@98573a183a502d2ca181d82d5deb46f88deb6d56",
"title": "98573a183a502d2ca181d82d5deb46f88deb6d56",
"url": "https://fuchsia.googlesource.com/integration/+/98573a183a502d2ca181d82d5deb46f88deb6d56"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c867bfc344f2e59fc57437be6d6e24f4361e1366"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c867bfc344f2e59fc57437be6d6e24f4361e1366",
"title": "c867bfc344f2e59fc57437be6d6e24f4361e1366",
"url": "https://fuchsia.googlesource.com/integration/+/c867bfc344f2e59fc57437be6d6e24f4361e1366"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8585ea7a872ee67d782c5d92ef129ffd2fe41002"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8585ea7a872ee67d782c5d92ef129ffd2fe41002",
"title": "8585ea7a872ee67d782c5d92ef129ffd2fe41002",
"url": "https://fuchsia.googlesource.com/integration/+/8585ea7a872ee67d782c5d92ef129ffd2fe41002"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "04bcc2fdb54a7b11d176c59624dad304e3254f9e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@04bcc2fdb54a7b11d176c59624dad304e3254f9e",
"title": "04bcc2fdb54a7b11d176c59624dad304e3254f9e",
"url": "https://fuchsia.googlesource.com/integration/+/04bcc2fdb54a7b11d176c59624dad304e3254f9e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c4ec3f19c370b2600e467e7b2679ac76ba2592a0"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c4ec3f19c370b2600e467e7b2679ac76ba2592a0",
"title": "c4ec3f19c370b2600e467e7b2679ac76ba2592a0",
"url": "https://fuchsia.googlesource.com/integration/+/c4ec3f19c370b2600e467e7b2679ac76ba2592a0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8079da6ab80509f7b2b754969cd44363aa8c69ed"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8079da6ab80509f7b2b754969cd44363aa8c69ed",
"title": "8079da6ab80509f7b2b754969cd44363aa8c69ed",
"url": "https://fuchsia.googlesource.com/integration/+/8079da6ab80509f7b2b754969cd44363aa8c69ed"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f75cce2cf6ca4b36712874641cf7e772b39aa54c"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f75cce2cf6ca4b36712874641cf7e772b39aa54c",
"title": "f75cce2cf6ca4b36712874641cf7e772b39aa54c",
"url": "https://fuchsia.googlesource.com/integration/+/f75cce2cf6ca4b36712874641cf7e772b39aa54c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "8a81bb641adecdbafc5a07b13bff02cd58f5c1c2"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@8a81bb641adecdbafc5a07b13bff02cd58f5c1c2",
"title": "8a81bb641adecdbafc5a07b13bff02cd58f5c1c2",
"url": "https://fuchsia.googlesource.com/integration/+/8a81bb641adecdbafc5a07b13bff02cd58f5c1c2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "087bada3d62e2e2b5b8f4b8e10bd9b88a724b064"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@087bada3d62e2e2b5b8f4b8e10bd9b88a724b064",
"title": "087bada3d62e2e2b5b8f4b8e10bd9b88a724b064",
"url": "https://fuchsia.googlesource.com/integration/+/087bada3d62e2e2b5b8f4b8e10bd9b88a724b064"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "46c78e43495629c60ecbacf81e81b894bb80cc0a"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@46c78e43495629c60ecbacf81e81b894bb80cc0a",
"title": "46c78e43495629c60ecbacf81e81b894bb80cc0a",
"url": "https://fuchsia.googlesource.com/integration/+/46c78e43495629c60ecbacf81e81b894bb80cc0a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5c39fc8acf5d3ec6af141470ff8d946ca27dfd98"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5c39fc8acf5d3ec6af141470ff8d946ca27dfd98",
"title": "5c39fc8acf5d3ec6af141470ff8d946ca27dfd98",
"url": "https://fuchsia.googlesource.com/integration/+/5c39fc8acf5d3ec6af141470ff8d946ca27dfd98"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "0b15a4ef1b8bf4ff08d4e2445697dc12eb9f6ce0"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@0b15a4ef1b8bf4ff08d4e2445697dc12eb9f6ce0",
"title": "0b15a4ef1b8bf4ff08d4e2445697dc12eb9f6ce0",
"url": "https://fuchsia.googlesource.com/integration/+/0b15a4ef1b8bf4ff08d4e2445697dc12eb9f6ce0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "ad88a028dab120be85c8b318e441b054b8606b17"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@ad88a028dab120be85c8b318e441b054b8606b17",
"title": "ad88a028dab120be85c8b318e441b054b8606b17",
"url": "https://fuchsia.googlesource.com/integration/+/ad88a028dab120be85c8b318e441b054b8606b17"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "09a6c1802e7bf3df94f88d5b6827aa590d10c7c7"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@09a6c1802e7bf3df94f88d5b6827aa590d10c7c7",
"title": "09a6c1802e7bf3df94f88d5b6827aa590d10c7c7",
"url": "https://fuchsia.googlesource.com/integration/+/09a6c1802e7bf3df94f88d5b6827aa590d10c7c7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "2e885929acc08c0d9c314c337af855a3bb7b342e"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@2e885929acc08c0d9c314c337af855a3bb7b342e",
"title": "2e885929acc08c0d9c314c337af855a3bb7b342e",
"url": "https://fuchsia.googlesource.com/integration/+/2e885929acc08c0d9c314c337af855a3bb7b342e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c8e7414bcfb1e123f5b4aa145135617fda3a26fe"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c8e7414bcfb1e123f5b4aa145135617fda3a26fe",
"title": "c8e7414bcfb1e123f5b4aa145135617fda3a26fe",
"url": "https://fuchsia.googlesource.com/integration/+/c8e7414bcfb1e123f5b4aa145135617fda3a26fe"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "efe81bf0cc435369c1ce661c124c48147f7cd757"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@efe81bf0cc435369c1ce661c124c48147f7cd757",
"title": "efe81bf0cc435369c1ce661c124c48147f7cd757",
"url": "https://fuchsia.googlesource.com/integration/+/efe81bf0cc435369c1ce661c124c48147f7cd757"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "7b8572e619e3cdd151c63884f8a5ab2dd18b2662"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@7b8572e619e3cdd151c63884f8a5ab2dd18b2662",
"title": "7b8572e619e3cdd151c63884f8a5ab2dd18b2662",
"url": "https://fuchsia.googlesource.com/integration/+/7b8572e619e3cdd151c63884f8a5ab2dd18b2662"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5edb3e1401ef01c13e7f2dad947389e25402786d"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5edb3e1401ef01c13e7f2dad947389e25402786d",
"title": "5edb3e1401ef01c13e7f2dad947389e25402786d",
"url": "https://fuchsia.googlesource.com/integration/+/5edb3e1401ef01c13e7f2dad947389e25402786d"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "5edb3e1401ef01c13e7f2dad947389e25402786d",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8938638956627055392"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/firebase-docs-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[20:30:27.863] Scheduled build:
{
"id": "8773208894310926193",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"createdBy": "project:fuchsia",
"createTime": "2023-08-09T20:30:27.236977897Z",
"updateTime": "2023-08-09T20:30:27.236977897Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "5edb3e1401ef01c13e7f2dad947389e25402786d",
"ref": "refs/heads/main"
}
}
}
[20:30:27.863] Task URL: https://cr-buildbucket.appspot.com/build/8773208894310926193
[20:30:27.863] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:2:0) after 1m47s
[20:30:28.384] Received PubSub notification, asking Buildbucket for the build status
[20:30:28.656] Build status: SCHEDULED
[20:30:35.264] Received PubSub notification, asking Buildbucket for the build status
[20:30:35.281] Build status: STARTED
[20:32:14.880] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:2:0)
[20:32:14.903] Build status: STARTED
[20:32:14.903] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:5:0) after 3m56s
[20:36:11.004] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:5:0)
[20:36:11.037] Build status: STARTED
[20:36:11.037] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:6:0) after 5m23s
[20:41:34.622] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:6:0)
[20:41:34.653] Build status: STARTED
[20:41:34.653] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:7:0) after 7m38s
[20:49:13.430] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:7:0)
[20:49:13.449] Build status: STARTED
[20:49:13.449] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:8:0) after 9m10s
[20:58:23.598] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:8:0)
[20:58:23.621] Build status: STARTED
[20:58:23.621] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:9:0) after 9m57s
[21:08:20.660] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:9:0)
[21:08:20.741] Build status: STARTED
[21:08:20.741] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:10:0) after 3m52s
[21:12:12.880] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:10:0)
[21:12:12.917] Build status: STARTED
[21:12:12.917] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:11:0) after 6m13s
[21:18:25.937] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:11:0)
[21:18:25.956] Build status: STARTED
[21:18:25.956] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:12:0) after 8m7s
[21:26:33.518] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:12:0)
[21:26:33.546] Build status: STARTED
[21:26:33.546] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:13:0) after 5m44s
[21:32:17.534] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:13:0)
[21:32:17.606] Build status: STARTED
[21:32:17.606] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:14:0) after 7m5s
[21:39:22.622] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:14:0)
[21:39:22.647] Build status: STARTED
[21:39:22.647] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:15:0) after 4m10s
[21:43:32.694] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:15:0)
[21:43:32.739] Build status: STARTED
[21:43:32.739] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:16:0) after 8m19s
[21:51:52.012] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:16:0)
[21:51:52.031] Build status: STARTED
[21:51:52.031] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:17:0) after 5m37s
[21:57:29.061] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:17:0)
[21:57:29.129] Build status: STARTED
[21:57:29.129] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:18:0) after 8m51s
[22:06:20.150] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:18:0)
[22:06:20.176] Build status: STARTED
[22:06:20.176] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:19:0) after 2m13s
[22:08:33.331] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:19:0)
[22:08:33.351] Build status: STARTED
[22:08:33.351] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:20:0) after 2m19s
[22:10:52.407] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:20:0)
[22:10:52.431] Build status: STARTED
[22:10:52.431] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:21:0) after 5m29s
[22:16:21.464] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:21:0)
[22:16:21.483] Build status: STARTED
[22:16:21.483] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8938638956627055392:22:0) after 9m28s
[22:17:24.062] Received PubSub notification, asking Buildbucket for the build status
[22:17:24.108] Build:
{
"id": "8773208894310926193",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"createdBy": "project:fuchsia",
"createTime": "2023-08-09T20:30:27.236977897Z",
"startTime": "2023-08-09T20:30:34.249653Z",
"endTime": "2023-08-09T22:17:23.650741236Z",
"updateTime": "2023-08-09T22:17:23.650741236Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "5edb3e1401ef01c13e7f2dad947389e25402786d",
"ref": "refs/heads/main"
}
}
}
[22:17:24.108] Invocation finished in 1h46m58.463831248s with status SUCCEEDED