these 2 derivations will be built: /nix/store/jc4dipjs8wpqqi3ka864i4idpp606zmz-nixos-test-driver-timescaledb.drv /nix/store/ry2gc6pcm0q7dw3iwgp0087vqyvih48w-vm-test-run-timescaledb.drv building '/nix/store/jc4dipjs8wpqqi3ka864i4idpp606zmz-nixos-test-driver-timescaledb.drv' on 'ssh-ng://nixbot-remote-build@78.232.36.247' building '/nix/store/jc4dipjs8wpqqi3ka864i4idpp606zmz-nixos-test-driver-timescaledb.drv' nixos-test-driver-timescaledb> Running type check (enable/disable: config.skipTypeCheck) nixos-test-driver-timescaledb> See https://nixos.org/manual/nixos/stable/#test-opt-skipTypeCheck nixos-test-driver-timescaledb> Success: no issues found in 1 source file nixos-test-driver-timescaledb> additionally exposed symbols: nixos-test-driver-timescaledb> , nixos-test-driver-timescaledb> , nixos-test-driver-timescaledb> start_all, test_script, machines, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, Machine, t, debug nixos-test-driver-timescaledb> Linting test script (enable/disable: config.skipLint) nixos-test-driver-timescaledb> See https://nixos.org/manual/nixos/stable/#test-opt-skipLint building '/nix/store/ry2gc6pcm0q7dw3iwgp0087vqyvih48w-vm-test-run-timescaledb.drv' on 'ssh-ng://builder@mac-linux-builder' building '/nix/store/ry2gc6pcm0q7dw3iwgp0087vqyvih48w-vm-test-run-timescaledb.drv' vm-test-run-timescaledb> Machine state will be reset. To keep it, pass --keep-vm-state vm-test-run-timescaledb> start all VLans vm-test-run-timescaledb> start vlan vm-test-run-timescaledb> running vlan (pid 7; ctl /build/vde1.ctl) vm-test-run-timescaledb> (finished: start all VLans, in 0.00 seconds) vm-test-run-timescaledb> Test will time out and terminate in 3600 seconds vm-test-run-timescaledb> run the VM test script vm-test-run-timescaledb> additionally exposed symbols: vm-test-run-timescaledb> server, vm-test-run-timescaledb> vlan1, vm-test-run-timescaledb> start_all, test_script, machines, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, Machine, t, debug vm-test-run-timescaledb> start all VMs vm-test-run-timescaledb> server: starting vm vm-test-run-timescaledb> mke2fs 1.47.3 (8-Jul-2025) vm-test-run-timescaledb> qemu-system-aarch64: Could not access KVM kernel module: No such file or directory vm-test-run-timescaledb> qemu-system-aarch64: failed to initialize kvm: No such file or directory vm-test-run-timescaledb> qemu-system-aarch64: falling back to tcg vm-test-run-timescaledb> server # Disk image does not exist, creating the virtualisation disk image... vm-test-run-timescaledb> server # Formatting '/build/vm-state-server/tmp.nxnN7aw4Qx', fmt=raw size=1073741824 vm-test-run-timescaledb> server # Discarding device blocks: 0/262144 done vm-test-run-timescaledb> server: QEMU running (pid 9) vm-test-run-timescaledb> server # Creating filesystem with 262144 4k blocks and 65536 inodes vm-test-run-timescaledb> server # Filesystem UUID: 0a760629-7ac5-4851-8cef-d7c991b449bc vm-test-run-timescaledb> server # Superblock backups stored on blocks: vm-test-run-timescaledb> server # 32768, 98304, 163840, 229376 vm-test-run-timescaledb> (finished: start all VMs, in 0.15 seconds) vm-test-run-timescaledb> server: waiting for unit supabase-db-init.service vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # Allocating group tables: 0/8 done vm-test-run-timescaledb> server # Writing inode tables: 0/8 done vm-test-run-timescaledb> server # Creating journal (8192 blocks): done vm-test-run-timescaledb> server # Writing superblocks and filesystem accounting information: 0/8 done vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # Virtualisation disk image created. vm-test-run-timescaledb> server: waiting for the VM to finish booting vm-test-run-timescaledb> server # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x000f0510] vm-test-run-timescaledb> server # [ 0.000000] Linux version 6.12.63 (nixbld@localhost) (gcc (GCC) 15.2.0, GNU ld (GNU Binutils) 2.44) #1-NixOS SMP Thu Dec 18 12:55:23 UTC 2025 vm-test-run-timescaledb> server # [ 0.000000] KASLR enabled vm-test-run-timescaledb> server # [ 0.000000] random: crng init done vm-test-run-timescaledb> server # [ 0.000000] Machine model: linux,dummy-virt vm-test-run-timescaledb> server # [ 0.000000] efi: UEFI not found. vm-test-run-timescaledb> server # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT vm-test-run-timescaledb> server # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] NODE_DATA(0) allocated [mem 0x13f602200-0x13f60593f] vm-test-run-timescaledb> server # [ 0.000000] Zone ranges: vm-test-run-timescaledb> server # [ 0.000000] DMA [mem 0x0000000040000000-0x00000000ffffffff] vm-test-run-timescaledb> server # [ 0.000000] DMA32 empty vm-test-run-timescaledb> server # [ 0.000000] Normal [mem 0x0000000100000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] Device empty vm-test-run-timescaledb> server # [ 0.000000] Movable zone start for each node vm-test-run-timescaledb> server # [ 0.000000] Early memory node ranges vm-test-run-timescaledb> server # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000013fffffff] vm-test-run-timescaledb> server # [ 0.000000] cma: Reserved 32 MiB at 0x00000000fe000000 on node -1 vm-test-run-timescaledb> server # [ 0.000000] psci: probing for conduit method from DT. vm-test-run-timescaledb> server # [ 0.000000] psci: PSCIv1.1 detected in firmware. vm-test-run-timescaledb> server # [ 0.000000] psci: Using standard PSCI v0.2 function IDs vm-test-run-timescaledb> server # [ 0.000000] psci: Trusted OS migration not required vm-test-run-timescaledb> server # [ 0.000000] psci: SMC Calling Convention v1.0 vm-test-run-timescaledb> server # [ 0.000000] percpu: Embedded 88 pages/cpu s180056 r65536 d114856 u360448 vm-test-run-timescaledb> server # [ 0.000000] Detected PIPT I-cache on CPU0 vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: Address authentication (IMP DEF algorithm) vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: GIC system register CPU interface vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: HCRX_EL2 register vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: 52-bit Virtual Addressing (LPA2) vm-test-run-timescaledb> server # [ 0.000000] CPU features: detected: Spectre-v4 vm-test-run-timescaledb> server # [ 0.000000] alternatives: applying boot alternatives vm-test-run-timescaledb> server # [ 0.000000] Kernel command line: console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/1pqrkv4qm784wvvk791v6yal33zchzhf-nixos-system-server-test/init regInfo=/nix/store/pj96bbc9j4v86yxdcyyfaj79jvclx2b3-closure-info/registration console=ttyAMA0,115200n8 console=tty0 vm-test-run-timescaledb> server # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/pj96bbc9j4v86yxdcyyfaj79jvclx2b3-closure-info/registration", will be passed to user space. vm-test-run-timescaledb> server # [ 0.000000] Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) vm-test-run-timescaledb> server # [ 0.000000] Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) vm-test-run-timescaledb> server # [ 0.000000] Fallback order for Node 0: 0 vm-test-run-timescaledb> server # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 1048576 vm-test-run-timescaledb> server # [ 0.000000] Policy zone: Normal vm-test-run-timescaledb> server # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off vm-test-run-timescaledb> server # [ 0.000000] software IO TLB: area num 2. vm-test-run-timescaledb> server # [ 0.000000] software IO TLB: mapped [mem 0x00000000fa000000-0x00000000fe000000] (64MB) vm-test-run-timescaledb> server # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1 vm-test-run-timescaledb> server # [ 0.000000] allocated 8388608 bytes of page_ext vm-test-run-timescaledb> server # [ 0.000000] ftrace: allocating 72257 entries in 283 pages vm-test-run-timescaledb> server # [ 0.000000] ftrace: allocated 283 pages with 5 groups vm-test-run-timescaledb> server # [ 0.000000] rcu: Hierarchical RCU implementation. vm-test-run-timescaledb> server # [ 0.000000] rcu: RCU event tracing is enabled. vm-test-run-timescaledb> server # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=2. vm-test-run-timescaledb> server # [ 0.000000] Rude variant of Tasks RCU enabled. vm-test-run-timescaledb> server # [ 0.000000] Tracing variant of Tasks RCU enabled. vm-test-run-timescaledb> server # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies. vm-test-run-timescaledb> server # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2 vm-test-run-timescaledb> server # [ 0.000000] RCU Tasks Rude: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. vm-test-run-timescaledb> server # [ 0.000000] RCU Tasks Trace: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. vm-test-run-timescaledb> server # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 vm-test-run-timescaledb> server # [ 0.000000] GICv3: 256 SPIs implemented vm-test-run-timescaledb> server # [ 0.000000] GICv3: 0 Extended SPIs implemented vm-test-run-timescaledb> server # [ 0.000000] Root IRQ handler: gic_handle_irq vm-test-run-timescaledb> server # [ 0.000000] GICv3: GICv3 features: 16 PPIs vm-test-run-timescaledb> server # [ 0.000000] GICv3: GICD_CTRL.DS=1, SCR_EL3.FIQ=0 vm-test-run-timescaledb> server # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000 vm-test-run-timescaledb> server # [ 0.000000] ITS [mem 0x08080000-0x0809ffff] vm-test-run-timescaledb> server # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @100ae0000 (indirect, esz 8, psz 64K, shr 1) vm-test-run-timescaledb> server # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @100af0000 (flat, esz 8, psz 64K, shr 1) vm-test-run-timescaledb> server # [ 0.000000] GICv3: using LPI property table @0x0000000100b00000 vm-test-run-timescaledb> server # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000100b10000 vm-test-run-timescaledb> server # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention. vm-test-run-timescaledb> server # [ 0.000000] arch_timer: cp15 timer(s) running at 1000.00MHz (virt). vm-test-run-timescaledb> server # [ 0.000000] clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns vm-test-run-timescaledb> server # [ 0.000038] sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns vm-test-run-timescaledb> server # [ 0.004127] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____) vm-test-run-timescaledb> server # [ 0.014734] Console: colour dummy device 80x25 vm-test-run-timescaledb> server # [ 0.016308] printk: legacy console [tty0] enabled vm-test-run-timescaledb> server # [ 0.021951] Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=4000000) vm-test-run-timescaledb> server # [ 0.022343] pid_max: default: 32768 minimum: 301 vm-test-run-timescaledb> server # [ 0.025028] LSM: initializing lsm=capability,landlock,yama,bpf vm-test-run-timescaledb> server # [ 0.027663] landlock: Up and running. vm-test-run-timescaledb> server # [ 0.027724] Yama: becoming mindful. vm-test-run-timescaledb> server # [ 0.031973] LSM support for eBPF active vm-test-run-timescaledb> server # [ 0.035365] Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.035563] Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.065882] cacheinfo: Unable to detect cache hierarchy for CPU 0 vm-test-run-timescaledb> server # [ 0.077335] rcu: Hierarchical SRCU implementation. vm-test-run-timescaledb> server # [ 0.077424] rcu: Max phase no-delay instances is 1000. vm-test-run-timescaledb> server # [ 0.078669] Timer migration: 1 hierarchy levels; 8 children per group; 1 crossnode level vm-test-run-timescaledb> server # [ 0.086558] fsl-mc MSI: its@8080000 domain created vm-test-run-timescaledb> server # [ 0.089399] EFI services will not be available. vm-test-run-timescaledb> server # [ 0.091069] smp: Bringing up secondary CPUs ... vm-test-run-timescaledb> server # [ 0.096108] Detected PIPT I-cache on CPU1 vm-test-run-timescaledb> server # [ 0.097269] GICv3: CPU1: found redistributor 1 region 0:0x00000000080c0000 vm-test-run-timescaledb> server # [ 0.098188] GICv3: CPU1: using allocated LPI pending table @0x0000000100b20000 vm-test-run-timescaledb> server # [ 0.100044] CPU1: Booted secondary processor 0x0000000001 [0x000f0510] vm-test-run-timescaledb> server # [ 0.103981] smp: Brought up 1 node, 2 CPUs vm-test-run-timescaledb> server # [ 0.104215] SMP: Total of 2 processors activated. vm-test-run-timescaledb> server # [ 0.104264] CPU: All CPU(s) started at EL1 vm-test-run-timescaledb> server # [ 0.104439] CPU features: detected: Branch Target Identification vm-test-run-timescaledb> server # [ 0.104495] CPU features: detected: 32-bit EL0 Support vm-test-run-timescaledb> server # [ 0.104527] CPU features: detected: 32-bit EL1 Support vm-test-run-timescaledb> server # [ 0.104553] CPU features: detected: ARMv8.4 Translation Table Level vm-test-run-timescaledb> server # [ 0.104588] CPU features: detected: Instruction cache invalidation not required for I/D coherence vm-test-run-timescaledb> server # [ 0.104632] CPU features: detected: Data cache clean to the PoU not required for I/D coherence vm-test-run-timescaledb> server # [ 0.104690] CPU features: detected: Common not Private translations vm-test-run-timescaledb> server # [ 0.104713] CPU features: detected: CRC32 instructions vm-test-run-timescaledb> server # [ 0.104733] CPU features: detected: Data cache clean to Point of Deep Persistence vm-test-run-timescaledb> server # [ 0.104765] CPU features: detected: Data cache clean to Point of Persistence vm-test-run-timescaledb> server # [ 0.104788] CPU features: detected: Data independent timing control (DIT) vm-test-run-timescaledb> server # [ 0.104813] CPU features: detected: E0PD vm-test-run-timescaledb> server # [ 0.104835] CPU features: detected: Enhanced Counter Virtualization vm-test-run-timescaledb> server # [ 0.104862] CPU features: detected: Enhanced Counter Virtualization (CNTPOFF) vm-test-run-timescaledb> server # [ 0.104890] CPU features: detected: Enhanced Privileged Access Never vm-test-run-timescaledb> server # [ 0.104916] CPU features: detected: Enhanced Virtualization Traps vm-test-run-timescaledb> server # [ 0.104939] CPU features: detected: Fine Grained Traps vm-test-run-timescaledb> server # [ 0.105000] CPU features: detected: Generic authentication (IMP DEF algorithm) vm-test-run-timescaledb> server # [ 0.105091] CPU features: detected: RCpc load-acquire (LDAPR) vm-test-run-timescaledb> server # [ 0.105140] CPU features: detected: 52-bit Virtual Addressing for KVM (LPA2) vm-test-run-timescaledb> server # [ 0.105167] CPU features: detected: LSE atomic instructions vm-test-run-timescaledb> server # [ 0.105191] CPU features: detected: Memory Copy and Memory Set instructions vm-test-run-timescaledb> server # [ 0.105215] CPU features: detected: Privileged Access Never vm-test-run-timescaledb> server # [ 0.105237] CPU features: detected: RAS Extension Support vm-test-run-timescaledb> server # [ 0.105257] CPU features: detected: Random Number Generator vm-test-run-timescaledb> server # [ 0.105279] CPU features: detected: Speculation barrier (SB) vm-test-run-timescaledb> server # [ 0.105304] CPU features: detected: Stage-2 Force Write-Back vm-test-run-timescaledb> server # [ 0.105325] CPU features: detected: Trap EL0 IMPLEMENTATION DEFINED functionality vm-test-run-timescaledb> server # [ 0.105351] CPU features: detected: TLB range maintenance instructions vm-test-run-timescaledb> server # [ 0.105373] CPU features: detected: WFx with timeout vm-test-run-timescaledb> server # [ 0.105550] CPU features: detected: Speculative Store Bypassing Safe (SSBS) vm-test-run-timescaledb> server # [ 0.105603] CPU features: detected: Scalable Vector Extension vm-test-run-timescaledb> server # [ 0.112715] alternatives: applying system-wide alternatives vm-test-run-timescaledb> server # [ 0.129029] CPU features: detected: Hardware dirty bit management on CPU0-1 vm-test-run-timescaledb> server # [ 0.129682] SVE: maximum available vector length 256 bytes per vector vm-test-run-timescaledb> server # [ 0.129778] SVE: default vector length 64 bytes per vector vm-test-run-timescaledb> server # [ 0.144184] Memory: 3922848K/4194304K available (23296K kernel code, 6546K rwdata, 24596K rodata, 4416K init, 1047K bss, 223164K reserved, 32768K cma-reserved) vm-test-run-timescaledb> server # [ 0.166194] devtmpfs: initialized vm-test-run-timescaledb> server # [ 0.195131] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns vm-test-run-timescaledb> server # [ 0.195668] futex hash table entries: 512 (order: 3, 32768 bytes, linear) vm-test-run-timescaledb> server # [ 0.198065] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL vm-test-run-timescaledb> server # [ 0.198126] 0 pages in range for non-PLT usage vm-test-run-timescaledb> server # [ 0.198169] 509248 pages in range for PLT usage vm-test-run-timescaledb> server # [ 0.201565] pinctrl core: initialized pinctrl subsystem vm-test-run-timescaledb> server # [ 0.214388] DMI not present or invalid. vm-test-run-timescaledb> server # [ 0.234581] NET: Registered PF_NETLINK/PF_ROUTE protocol family vm-test-run-timescaledb> server # [ 0.247356] DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations vm-test-run-timescaledb> server # [ 0.248887] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations vm-test-run-timescaledb> server # [ 0.250192] DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations vm-test-run-timescaledb> server # [ 0.250467] audit: initializing netlink subsys (disabled) vm-test-run-timescaledb> server # [ 0.253006] audit: type=2000 audit(0.192:1): state=initialized audit_enabled=0 res=1 vm-test-run-timescaledb> server # [ 0.259597] thermal_sys: Registered thermal governor 'fair_share' vm-test-run-timescaledb> server # [ 0.259658] thermal_sys: Registered thermal governor 'bang_bang' vm-test-run-timescaledb> server # [ 0.259712] thermal_sys: Registered thermal governor 'step_wise' vm-test-run-timescaledb> server # [ 0.259742] thermal_sys: Registered thermal governor 'user_space' vm-test-run-timescaledb> server # [ 0.259770] thermal_sys: Registered thermal governor 'power_allocator' vm-test-run-timescaledb> server # [ 0.260712] cpuidle: using governor ladder vm-test-run-timescaledb> server # [ 0.261148] cpuidle: using governor menu vm-test-run-timescaledb> server # [ 0.263203] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. vm-test-run-timescaledb> server # [ 0.264382] ASID allocator initialised with 65536 entries vm-test-run-timescaledb> server # [ 0.272592] Serial: AMBA PL011 UART driver vm-test-run-timescaledb> server # [ 0.323485] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1 vm-test-run-timescaledb> server # [ 0.325323] printk: legacy console [ttyAMA0] enabled vm-test-run-timescaledb> server # [ 0.364759] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.364973] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page vm-test-run-timescaledb> server # [ 0.365079] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.365201] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page vm-test-run-timescaledb> server # [ 0.365302] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.365406] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page vm-test-run-timescaledb> server # [ 0.365506] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages vm-test-run-timescaledb> server # [ 0.366007] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page vm-test-run-timescaledb> server # [ 0.379471] fbcon: Taking over console vm-test-run-timescaledb> server # [ 0.380937] ACPI: Interpreter disabled. vm-test-run-timescaledb> server # [ 0.389739] iommu: Default domain type: Translated vm-test-run-timescaledb> server # [ 0.389937] iommu: DMA domain TLB invalidation policy: strict mode vm-test-run-timescaledb> server # [ 0.395324] SCSI subsystem initialized vm-test-run-timescaledb> server # [ 0.397606] usbcore: registered new interface driver usbfs vm-test-run-timescaledb> server # [ 0.398351] usbcore: registered new interface driver hub vm-test-run-timescaledb> server # [ 0.398717] usbcore: registered new device driver usb vm-test-run-timescaledb> server # [ 0.401206] pps_core: LinuxPPS API ver. 1 registered vm-test-run-timescaledb> server # [ 0.401421] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti vm-test-run-timescaledb> server # [ 0.401641] PTP clock support registered vm-test-run-timescaledb> server # [ 0.403324] EDAC MC: Ver: 3.0.0 vm-test-run-timescaledb> server # [ 0.404953] scmi_core: SCMI protocol bus registered vm-test-run-timescaledb> server # [ 0.408739] FPGA manager framework vm-test-run-timescaledb> server # [ 0.409878] Advanced Linux Sound Architecture Driver Initialized. vm-test-run-timescaledb> server # [ 0.418370] vgaarb: loaded vm-test-run-timescaledb> server # [ 0.422472] clocksource: Switched to clocksource arch_sys_counter vm-test-run-timescaledb> server # [ 0.425674] VFS: Disk quotas dquot_6.6.0 vm-test-run-timescaledb> server # [ 0.425884] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) vm-test-run-timescaledb> server # [ 0.428808] netfs: FS-Cache loaded vm-test-run-timescaledb> server # [ 0.431220] pnp: PnP ACPI: disabled vm-test-run-timescaledb> server # [ 0.456127] NET: Registered PF_INET protocol family vm-test-run-timescaledb> server # [ 0.457813] IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) vm-test-run-timescaledb> server # [ 0.573157] tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) vm-test-run-timescaledb> server # [ 0.573689] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) vm-test-run-timescaledb> server # [ 0.574116] TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) vm-test-run-timescaledb> server # [ 0.575934] TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) vm-test-run-timescaledb> server # [ 0.576726] TCP: Hash tables configured (established 32768 bind 32768) vm-test-run-timescaledb> server # [ 0.578243] MPTCP token hash table entries: 4096 (order: 5, 98304 bytes, linear) vm-test-run-timescaledb> server # [ 0.578821] UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.579446] UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) vm-test-run-timescaledb> server # [ 0.580987] NET: Registered PF_UNIX/PF_LOCAL protocol family vm-test-run-timescaledb> server # [ 0.581422] NET: Registered PF_XDP protocol family vm-test-run-timescaledb> server # [ 0.581620] PCI: CLS 0 bytes, default 64 vm-test-run-timescaledb> server # [ 0.583366] kvm [1]: HYP mode not available vm-test-run-timescaledb> server # [ 0.585700] Trying to unpack rootfs image as initramfs... vm-test-run-timescaledb> server # [ 0.687167] Initialise system trusted keyrings vm-test-run-timescaledb> server # [ 0.689165] workingset: timestamp_bits=42 max_order=20 bucket_order=0 vm-test-run-timescaledb> server # [ 0.693764] squashfs: version 4.0 (2009/01/31) Phillip Lougher vm-test-run-timescaledb> server # [ 0.695697] 9p: Installing v9fs 9p2000 file system support vm-test-run-timescaledb> server # [ 0.757768] Key type asymmetric registered vm-test-run-timescaledb> server # [ 0.758006] Asymmetric key parser 'x509' registered vm-test-run-timescaledb> server # [ 0.758896] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 244) vm-test-run-timescaledb> server # [ 0.760830] io scheduler mq-deadline registered vm-test-run-timescaledb> server # [ 0.761079] io scheduler kyber registered vm-test-run-timescaledb> server # [ 0.793238] pl061_gpio 9030000.pl061: PL061 GPIO chip registered vm-test-run-timescaledb> server # [ 0.798000] ledtrig-cpu: registered to indicate activity on CPUs vm-test-run-timescaledb> server # [ 0.802396] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges: vm-test-run-timescaledb> server # [ 0.803491] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000 vm-test-run-timescaledb> server # [ 0.804077] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000 vm-test-run-timescaledb> server # [ 0.804271] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000 vm-test-run-timescaledb> server # [ 0.805084] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits vm-test-run-timescaledb> server # [ 0.806030] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff] vm-test-run-timescaledb> server # [ 0.808267] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00 vm-test-run-timescaledb> server # [ 0.809004] pci_bus 0000:00: root bus resource [bus 00-ff] vm-test-run-timescaledb> server # [ 0.809468] pci_bus 0000:00: root bus resource [io 0x0000-0xffff] vm-test-run-timescaledb> server # [ 0.809901] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff] vm-test-run-timescaledb> server # [ 0.810153] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff] vm-test-run-timescaledb> server # [ 0.812093] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.815953] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.816315] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.816486] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.816643] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.817481] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref] vm-test-run-timescaledb> server # [ 0.818069] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.818445] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.818552] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.819100] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.820220] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.820638] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f] vm-test-run-timescaledb> server # [ 0.820757] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.820878] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.821362] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.821546] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.821699] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.821828] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.823787] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.824182] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.824460] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.824597] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.825159] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.825454] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f] vm-test-run-timescaledb> server # [ 0.825553] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.825667] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.826127] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.826432] pci 0000:00:07.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.826539] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.826668] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.826917] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref] vm-test-run-timescaledb> server # [ 0.827588] pci 0000:00:08.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.827769] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.827893] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.828329] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.828998] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.829126] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.829748] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.830004] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.831255] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.831518] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f] vm-test-run-timescaledb> server # [ 0.831849] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.831972] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.832477] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint vm-test-run-timescaledb> server # [ 0.833014] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f] vm-test-run-timescaledb> server # [ 0.833145] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-timescaledb> server # [ 0.833259] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-timescaledb> server # [ 0.836522] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned vm-test-run-timescaledb> server # [ 0.836817] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned vm-test-run-timescaledb> server # [ 0.837067] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.837501] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.837678] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.837817] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.837953] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.838094] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.838241] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.838392] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.838538] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.838671] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.838818] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned vm-test-run-timescaledb> server # [ 0.838956] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned vm-test-run-timescaledb> server # [ 0.840268] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned vm-test-run-timescaledb> server # [ 0.840424] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned vm-test-run-timescaledb> server # [ 0.840541] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned vm-test-run-timescaledb> server # [ 0.840656] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned vm-test-run-timescaledb> server # [ 0.840765] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned vm-test-run-timescaledb> server # [ 0.840886] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned vm-test-run-timescaledb> server # [ 0.840995] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned vm-test-run-timescaledb> server # [ 0.841105] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned vm-test-run-timescaledb> server # [ 0.841214] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned vm-test-run-timescaledb> server # [ 0.841326] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned vm-test-run-timescaledb> server # [ 0.841436] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned vm-test-run-timescaledb> server # [ 0.841555] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned vm-test-run-timescaledb> server # [ 0.841679] pci 0000:00:03.0: BAR 0 [io 0x1080-0x10bf]: assigned vm-test-run-timescaledb> server # [ 0.841784] pci 0000:00:0b.0: BAR 0 [io 0x10c0-0x10ff]: assigned vm-test-run-timescaledb> server # [ 0.841885] pci 0000:00:01.0: BAR 0 [io 0x1100-0x111f]: assigned vm-test-run-timescaledb> server # [ 0.842001] pci 0000:00:02.0: BAR 0 [io 0x1120-0x113f]: assigned vm-test-run-timescaledb> server # [ 0.842107] pci 0000:00:04.0: BAR 0 [io 0x1140-0x115f]: assigned vm-test-run-timescaledb> server # [ 0.842210] pci 0000:00:05.0: BAR 0 [io 0x1160-0x117f]: assigned vm-test-run-timescaledb> server # [ 0.842317] pci 0000:00:07.0: BAR 0 [io 0x1180-0x119f]: assigned vm-test-run-timescaledb> server # [ 0.842416] pci 0000:00:0c.0: BAR 0 [io 0x11a0-0x11bf]: assigned vm-test-run-timescaledb> server # [ 0.842726] pci_bus 0000:00: resource 4 [io 0x0000-0xffff] vm-test-run-timescaledb> server # [ 0.842835] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff] vm-test-run-timescaledb> server # [ 0.844283] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff] vm-test-run-timescaledb> server # [ 0.845233] pci 0000:00:0a.0: enabling device (0000 -> 0002) vm-test-run-timescaledb> server # [ 0.908814] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.912548] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.915710] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.918173] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.920607] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.923488] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.927854] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.930462] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002) vm-test-run-timescaledb> server # [ 0.933020] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002) vm-test-run-timescaledb> server # [ 0.935607] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.939520] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003) vm-test-run-timescaledb> server # [ 0.956234] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled vm-test-run-timescaledb> server # [ 0.967045] msm_serial: driver initialized vm-test-run-timescaledb> server # [ 0.967891] SuperH (H)SCI(F) driver initialized vm-test-run-timescaledb> server # [ 0.968828] STM32 USART driver initialized vm-test-run-timescaledb> server # [ 1.020206] loop: module loaded vm-test-run-timescaledb> server # [ 1.020802] virtio_blk virtio5: 2/0/0 default/read/poll queues vm-test-run-timescaledb> server # [ 1.025106] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB) vm-test-run-timescaledb> server # [ 1.039811] megasas: 07.727.03.00-rc1 vm-test-run-timescaledb> server # [ 1.045784] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff] vm-test-run-timescaledb> server # [ 1.048422] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 vm-test-run-timescaledb> server # [ 1.049179] Intel/Sharp Extended Query Table at 0x0031 vm-test-run-timescaledb> server # [ 1.050278] Using buffer write method vm-test-run-timescaledb> server # [ 1.051223] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff] vm-test-run-timescaledb> server # [ 1.052308] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 vm-test-run-timescaledb> server # [ 1.052544] Intel/Sharp Extended Query Table at 0x0031 vm-test-run-timescaledb> server # [ 1.054150] Using buffer write method vm-test-run-timescaledb> server # [ 1.054765] Concatenating MTD devices: vm-test-run-timescaledb> server # [ 1.054953] (0): "0.flash" vm-test-run-timescaledb> server # [ 1.055414] (1): "0.flash" vm-test-run-timescaledb> server # [ 1.055484] into device "0.flash" vm-test-run-timescaledb> server # [ 1.058017] Freeing initrd memory: 10684K vm-test-run-timescaledb> server # [ 1.078589] tun: Universal TUN/TAP device driver, 1.6 vm-test-run-timescaledb> server # [ 1.093104] thunder_xcv, ver 1.0 vm-test-run-timescaledb> server # [ 1.093347] thunder_bgx, ver 1.0 vm-test-run-timescaledb> server # [ 1.093510] nicpf, ver 1.0 vm-test-run-timescaledb> server # [ 1.097016] hns3: Hisilicon Ethernet Network Driver for Hip08 Family - version vm-test-run-timescaledb> server # [ 1.097317] hns3: Copyright (c) 2017 Huawei Corporation. vm-test-run-timescaledb> server # [ 1.097777] hclge is initializing vm-test-run-timescaledb> server # [ 1.098324] e1000: Intel(R) PRO/1000 Network Driver vm-test-run-timescaledb> server # [ 1.098432] e1000: Copyright (c) 1999-2006 Intel Corporation. vm-test-run-timescaledb> server # [ 1.098645] e1000e: Intel(R) PRO/1000 Network Driver vm-test-run-timescaledb> server # [ 1.098729] e1000e: Copyright(c) 1999 - 2015 Intel Corporation. vm-test-run-timescaledb> server # [ 1.099273] igb: Intel(R) Gigabit Ethernet Network Driver vm-test-run-timescaledb> server # [ 1.099364] igb: Copyright (c) 2007-2014 Intel Corporation. vm-test-run-timescaledb> server # [ 1.099703] igbvf: Intel(R) Gigabit Virtual Function Network Driver vm-test-run-timescaledb> server # [ 1.099841] igbvf: Copyright (c) 2009 - 2012 Intel Corporation. vm-test-run-timescaledb> server # [ 1.100710] sky2: driver version 1.30 vm-test-run-timescaledb> server # [ 1.108657] ehci-pci 0000:00:0a.0: EHCI Host Controller vm-test-run-timescaledb> server # [ 1.109171] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1 vm-test-run-timescaledb> server # [ 1.113749] usbcore: registered new interface driver usb-storage vm-test-run-timescaledb> server # [ 1.114275] usbcore: registered new interface driver usbserial_generic vm-test-run-timescaledb> server # [ 1.114613] usbserial: USB Serial support registered for generic vm-test-run-timescaledb> server # [ 1.118010] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000 vm-test-run-timescaledb> server # [ 1.125290] rtc-pl031 9010000.pl031: registered as rtc0 vm-test-run-timescaledb> server # [ 1.126134] rtc-pl031 9010000.pl031: setting system clock to 2026-10-26T08:09:36 UTC (1793002176) vm-test-run-timescaledb> server # [ 1.127519] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00 vm-test-run-timescaledb> server # [ 1.128837] i2c_dev: i2c /dev entries driver vm-test-run-timescaledb> server # [ 1.135772] hub 1-0:1.0: USB hub found vm-test-run-timescaledb> server # [ 1.136353] hub 1-0:1.0: 6 ports detected vm-test-run-timescaledb> server # [ 1.145858] sdhci: Secure Digital Host Controller Interface driver vm-test-run-timescaledb> server # [ 1.146048] sdhci: Copyright(c) Pierre Ossman vm-test-run-timescaledb> server # [ 1.147717] Synopsys Designware Multimedia Card Interface Driver vm-test-run-timescaledb> server # [ 1.149664] sdhci-pltfm: SDHCI platform and OF driver helper vm-test-run-timescaledb> server # [ 1.157215] hid: raw HID events driver (C) Jiri Kosina vm-test-run-timescaledb> server # [ 1.159753] usbcore: registered new interface driver usbhid vm-test-run-timescaledb> server # [ 1.159909] usbhid: USB HID core driver vm-test-run-timescaledb> server # [ 1.169510] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available vm-test-run-timescaledb> server # [ 1.183912] drop_monitor: Initializing network drop monitor service vm-test-run-timescaledb> server # [ 1.185423] NET: Registered PF_INET6 protocol family vm-test-run-timescaledb> server # [ 1.205429] Segment Routing with IPv6 vm-test-run-timescaledb> server # [ 1.205902] In-situ OAM (IOAM) with IPv6 vm-test-run-timescaledb> server # [ 1.207607] NET: Registered PF_PACKET protocol family vm-test-run-timescaledb> server # [ 1.209095] 9pnet: Installing 9P2000 support vm-test-run-timescaledb> server # [ 1.214185] Key type dns_resolver registered vm-test-run-timescaledb> server # [ 1.253557] registered taskstats version 1 vm-test-run-timescaledb> server # [ 1.256318] Loading compiled-in X.509 certificates vm-test-run-timescaledb> server # [ 1.317379] Demotion targets for Node 0: null vm-test-run-timescaledb> server # [ 1.320128] Key type .fscrypt registered vm-test-run-timescaledb> server # [ 1.320286] Key type fscrypt-provisioning registered vm-test-run-timescaledb> server # [ 1.330328] input: gpio-keys as /devices/platform/gpio-keys/input/input0 vm-test-run-timescaledb> server # [ 1.375927] clk: Disabling unused clocks vm-test-run-timescaledb> server # [ 1.376565] PM: genpd: Disabling unused power domains vm-test-run-timescaledb> server # [ 1.376875] ALSA device list: vm-test-run-timescaledb> server # [ 1.376983] No soundcards found. vm-test-run-timescaledb> server # [ 1.391479] usb 1-1: new high-speed USB device number 2 using ehci-pci vm-test-run-timescaledb> server # [ 1.459496] Freeing unused kernel memory: 4416K vm-test-run-timescaledb> server # [ 1.461884] Run /init as init process vm-test-run-timescaledb> server # [ 1.582856] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1 vm-test-run-timescaledb> server # [ 1.737472] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0 vm-test-run-timescaledb> server # [ 1.859511] usb 1-2: new high-speed USB device number 3 using ehci-pci vm-test-run-timescaledb> server # [ 2.044885] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2 vm-test-run-timescaledb> server # [ 2.047322] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0 vm-test-run-timescaledb> server # [ 2.119449] device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@lists.linux.dev vm-test-run-timescaledb> server # [ 2.258148] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0 vm-test-run-timescaledb> server # [ 2.259675] [drm] features: -virgl +edid -resource_blob -host_visible vm-test-run-timescaledb> server # [ 2.259710] [drm] features: -context_init vm-test-run-timescaledb> server # [ 2.261662] [drm] number of scanouts: 1 vm-test-run-timescaledb> server # [ 2.261772] [drm] number of cap sets: 0 vm-test-run-timescaledb> server # [ 2.272024] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0 vm-test-run-timescaledb> server # [ 2.305163] Console: switching to colour frame buffer device 160x50 vm-test-run-timescaledb> server # [ 2.317255] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device vm-test-run-timescaledb> server # [ 5.277666] EXT4-fs (vda): mounted filesystem 0a760629-7ac5-4851-8cef-d7c991b449bc r/w with ordered data mode. Quota mode: none. vm-test-run-timescaledb> server # [ 7.947358] EXT4-fs (vda): re-mounted 0a760629-7ac5-4851-8cef-d7c991b449bc. vm-test-run-timescaledb> server # [ 7.970433] booting system configuration /nix/store/1pqrkv4qm784wvvk791v6yal33zchzhf-nixos-system-server-test vm-test-run-timescaledb> server # [ 21.654130] systemd[1]: systemd 258.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 -IDN -IPTC +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP -SYSVINIT +LIBARCHIVE) vm-test-run-timescaledb> server # [ 21.666051] systemd[1]: Detected virtualization qemu. vm-test-run-timescaledb> server # [ 21.672075] systemd[1]: Detected architecture arm64. vm-test-run-timescaledb> server # [ 21.677339] systemd[1]: Detected first boot. vm-test-run-timescaledb> server # [ 21.711832] systemd[1]: Initializing machine ID from random generator. vm-test-run-timescaledb> server # [ 21.745904] systemd[1]: Hostname set to . vm-test-run-timescaledb> server # [ 23.025733] systemd[1]: bpf-restrict-fs: LSM BPF program attached vm-test-run-timescaledb> server # [ 24.471081] systemd[1]: Applying preset policy. vm-test-run-timescaledb> server # [ 28.604905] systemd[1]: Populated /etc with preset unit settings. vm-test-run-timescaledb> server: Guest root shell did not produce any data yet... vm-test-run-timescaledb> server: To debug, enter the VM and run 'systemctl status backdoor.service'. vm-test-run-timescaledb> server # [ 32.229950] systemd[1]: Queued start job for default target Multi-User System. vm-test-run-timescaledb> server # [ 32.465336] systemd[1]: Created slice Slice /system/getty. vm-test-run-timescaledb> server # [ 32.482114] systemd[1]: Created slice Slice /system/modprobe. vm-test-run-timescaledb> server # [ 32.497769] systemd[1]: Created slice User and Session Slice. vm-test-run-timescaledb> server # [ 32.507649] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. vm-test-run-timescaledb> server # [ 32.512915] systemd[1]: Started Forward Password Requests to Wall Directory Watch. vm-test-run-timescaledb> server # [ 32.519527] systemd[1]: Expecting device /dev/hvc0... vm-test-run-timescaledb> server # [ 32.523811] systemd[1]: Expecting device /dev/ttyAMA0... vm-test-run-timescaledb> server # [ 32.527977] systemd[1]: Expecting device /sys/subsystem/net/devices/eth1... vm-test-run-timescaledb> server # [ 32.532459] systemd[1]: Reached target Local Encrypted Volumes. vm-test-run-timescaledb> server # [ 32.537263] systemd[1]: Reached target Virtual Machines and Containers. vm-test-run-timescaledb> server # [ 32.542597] systemd[1]: Reached target Path Units. vm-test-run-timescaledb> server # [ 32.548539] systemd[1]: Reached target Remote File Systems. vm-test-run-timescaledb> server # [ 32.553006] systemd[1]: Reached target Slice Units. vm-test-run-timescaledb> server # [ 32.557705] systemd[1]: Reached target Swaps. vm-test-run-timescaledb> server # [ 32.601887] systemd[1]: Listening on Process Core Dump Socket. vm-test-run-timescaledb> server # [ 32.638108] systemd[1]: Listening on Credential Encryption/Decryption. vm-test-run-timescaledb> server # [ 32.652835] systemd[1]: Listening on Journal Audit Socket. vm-test-run-timescaledb> server # [ 32.660184] systemd[1]: Listening on Journal Socket (/dev/log). vm-test-run-timescaledb> server # [ 32.667381] systemd[1]: Listening on Journal Sockets. vm-test-run-timescaledb> server # [ 32.676472] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket. vm-test-run-timescaledb> server # [ 32.681456] systemd[1]: Make TPM PCR Policy was skipped because of an unmet condition check (ConditionSecurity=measured-uki). vm-test-run-timescaledb> server # [ 32.688582] systemd[1]: Listening on udev Control Socket. vm-test-run-timescaledb> server # [ 32.695377] systemd[1]: Listening on udev Kernel Socket. vm-test-run-timescaledb> server # [ 32.756735] systemd[1]: Mounting Huge Pages File System... vm-test-run-timescaledb> server # [ 32.804636] systemd[1]: Mounting POSIX Message Queue File System... vm-test-run-timescaledb> server # [ 32.860434] systemd[1]: Mounting Kernel Debug File System... vm-test-run-timescaledb> server # [ 32.914117] systemd[1]: Mounting Kernel Trace File System... vm-test-run-timescaledb> server # [ 33.069562] systemd[1]: Starting Create List of Static Device Nodes... vm-test-run-timescaledb> server # [ 33.205445] systemd[1]: Starting Load Kernel Module 9pnet_virtio... vm-test-run-timescaledb> server # [ 33.228006] systemd[1]: Load Kernel Module configfs was skipped because of an unmet condition check (ConditionKernelModuleLoaded=!configfs). vm-test-run-timescaledb> server # [ 33.396926] systemd[1]: Mounting Kernel Configuration File System... vm-test-run-timescaledb> server # [ 33.423601] systemd[1]: Load Kernel Module drm was skipped because of an unmet condition check (ConditionKernelModuleLoaded=!drm). vm-test-run-timescaledb> server # [ 33.439760] systemd[1]: Load Kernel Module efi_pstore was skipped because of an unmet condition check (ConditionKernelModuleLoaded=!efi_pstore). vm-test-run-timescaledb> server # [ 33.577269] systemd[1]: Starting Load Kernel Module fuse... vm-test-run-timescaledb> server # [ 33.588715] systemd[1]: File System Check on Root Device was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). vm-test-run-timescaledb> server # [ 33.600461] systemd[1]: Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). vm-test-run-timescaledb> server # [ 33.717409] systemd[1]: Starting Journal Service... vm-test-run-timescaledb> server # [ 33.812187] systemd[1]: Starting Load Kernel Modules... vm-test-run-timescaledb> server # [ 33.914524] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer... vm-test-run-timescaledb> server # [ 33.972238] systemd[1]: Starting Remount Root and Kernel File Systems... vm-test-run-timescaledb> server # [ 33.982665] systemd[1]: Early TPM SRK Setup was skipped because of an unmet condition check (ConditionSecurity=measured-uki). vm-test-run-timescaledb> server # [ 34.052526] systemd[1]: Starting Coldplug All udev Devices... vm-test-run-timescaledb> server # [ 34.134307] systemd[1]: Mounted Huge Pages File System. vm-test-run-timescaledb> server # [ 34.152420] systemd[1]: Mounted POSIX Message Queue File System. vm-test-run-timescaledb> server # [ 34.160541] systemd[1]: Mounted Kernel Debug File System. vm-test-run-timescaledb> server # [ 34.161709] systemd[1]: Mounted Kernel Trace File System. vm-test-run-timescaledb> server # [ 34.176316] systemd[1]: Finished Create List of Static Device Nodes. vm-test-run-timescaledb> server # [ 34.193803] systemd[1]: Mounted Kernel Configuration File System. vm-test-run-timescaledb> server # [ 34.286309] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... vm-test-run-timescaledb> server # [ 34.494586] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 34.512584] systemd[1]: Finished Load Kernel Module 9pnet_virtio. vm-test-run-timescaledb> server # [ 35.084939] fuse: init (API version 7.41) vm-test-run-timescaledb> server # [ 35.204271] systemd[1]: modprobe@fuse.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 35.224313] systemd[1]: Finished Load Kernel Module fuse. vm-test-run-timescaledb> server # [ 35.297982] systemd[1]: Mounting FUSE Control File System... vm-test-run-timescaledb> server # [ 35.336968] systemd[1]: Finished Load Kernel Modules. vm-test-run-timescaledb> server # [ 35.454392] systemd[1]: Starting Firewall... vm-test-run-timescaledb> server # [ 35.491653] EXT4-fs (vda): re-mounted 0a760629-7ac5-4851-8cef-d7c991b449bc. vm-test-run-timescaledb> server # [ 35.545913] systemd[1]: Starting Apply Kernel Variables... vm-test-run-timescaledb> server # [ 35.676847] systemd[1]: Mounted FUSE Control File System. vm-test-run-timescaledb> server # [ 35.786423] systemd[1]: Finished Remount Root and Kernel File Systems. vm-test-run-timescaledb> server # [ 35.794239] systemd[1]: Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). vm-test-run-timescaledb> server # [ 35.884070] systemd[1]: Starting Load/Save OS Random Seed... vm-test-run-timescaledb> server # [ 35.892231] systemd[1]: TPM SRK Setup was skipped because of an unmet condition check (ConditionSecurity=measured-uki). vm-test-run-timescaledb> server # [ 35.920713] systemd-journald[396]: Collecting audit messages is enabled. vm-test-run-timescaledb> server # [ 36.909935] systemd[1]: Finished Load/Save OS Random Seed. vm-test-run-timescaledb> server # [ 36.925087] systemd[1]: Reached target First Boot Complete. vm-test-run-timescaledb> server # [ 37.065873] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. vm-test-run-timescaledb> server # [ 37.134460] systemd[1]: Starting Create Static Device Nodes in /dev... vm-test-run-timescaledb> server # [ 37.406487] systemd[1]: Finished Apply Kernel Variables. vm-test-run-timescaledb> server # [ 37.593384] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer. vm-test-run-timescaledb> server # [ 38.508041] systemd[1]: Finished Create Static Device Nodes in /dev. vm-test-run-timescaledb> server # [ 38.535931] systemd[1]: Reached target Preparation for Local File Systems. vm-test-run-timescaledb> server # [ 38.593808] systemd[1]: Mounting /run/wrappers... vm-test-run-timescaledb> server # [ 38.655545] systemd[1]: Starting Rule-based Manager for Device Events and Files... vm-test-run-timescaledb> server # [ 38.860834] systemd[1]: Started Journal Service. vm-test-run-timescaledb> server # [ 38.846130] systemd-modules-load[397]: Module 'atkbd' is built in vm-test-run-timescaledb> server # [ 38.874298] systemd-modules-load[397]: Module 'loop' is built in vm-test-run-timescaledb> server # [ 38.912033] systemd-oomd[398]: No swap; memory pressure usage will be degraded vm-test-run-timescaledb> server # [ 38.960606] systemd[1]: Starting Flush Journal to Persistent Storage... vm-test-run-timescaledb> server # [ 39.238170] systemd[1]: Mounted /run/wrappers. vm-test-run-timescaledb> server # [ 39.270330] systemd[1]: Reached target Local File Systems. vm-test-run-timescaledb> server # [ 39.298394] systemd[1]: Listening on Boot Entries Service Socket. vm-test-run-timescaledb> server # [ 39.338298] systemd[1]: Starting Create SUID/SGID Wrappers... vm-test-run-timescaledb> server # [ 39.356538] systemd[1]: Update Boot Loader Random Seed was skipped because no trigger condition checks were met. vm-test-run-timescaledb> server # [ 39.409316] systemd[1]: Starting Save Transient machine-id to Disk... vm-test-run-timescaledb> server # [ 40.001614] systemd-journald[396]: Received client request to flush runtime journal. vm-test-run-timescaledb> server # [ 40.697352] systemd-udevd[425]: Using default interface naming scheme 'v258'. vm-test-run-timescaledb> server # [ 40.743262] systemd[1]: etc-machine\x2did.mount: Deactivated successfully. vm-test-run-timescaledb> server # [ 40.755080] systemd[1]: Finished Save Transient machine-id to Disk. vm-test-run-timescaledb> server # [ 40.767089] systemd[1]: Finished Flush Journal to Persistent Storage. vm-test-run-timescaledb> server # [ 40.778748] systemd[1]: Starting Create System Files and Directories... vm-test-run-timescaledb> server # [ 42.883447] systemd[1]: Finished Create System Files and Directories. vm-test-run-timescaledb> server # [ 42.947811] systemd[1]: Starting Rebuild Journal Catalog... vm-test-run-timescaledb> server # [ 43.016691] systemd[1]: Starting Record System Boot/Shutdown in UTMP... vm-test-run-timescaledb> server # [ 43.358223] systemd[1]: Started Rule-based Manager for Device Events and Files. vm-test-run-timescaledb> server # [ 44.163844] systemd[1]: Finished Record System Boot/Shutdown in UTMP. vm-test-run-timescaledb> server # [ 45.327052] systemd[1]: Finished Rebuild Journal Catalog. vm-test-run-timescaledb> server # [ 45.374026] systemd[1]: Starting Update is Completed... vm-test-run-timescaledb> server # [ 46.163689] systemd[1]: Finished Update is Completed. vm-test-run-timescaledb> server # [ 49.959894] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 49.971474] systemd[1]: Finished Create SUID/SGID Wrappers. vm-test-run-timescaledb> server # [ 49.974622] systemd[1]: suid-sgid-wrappers.service: Consumed 2.910s CPU time, 5.6M memory peak. vm-test-run-timescaledb> server # [ 52.582125] systemd[1]: Finished Firewall. vm-test-run-timescaledb> server # [ 54.311734] systemd[1]: Finished Coldplug All udev Devices. vm-test-run-timescaledb> server # [ 54.331617] systemd[1]: Reached target System Initialization. vm-test-run-timescaledb> server # [ 54.345556] systemd[1]: Started Discard unused filesystem blocks once a week. vm-test-run-timescaledb> server # [ 54.359211] systemd[1]: Started Daily Cleanup of Temporary Directories. vm-test-run-timescaledb> server # [ 54.369945] systemd[1]: Reached target Timer Units. vm-test-run-timescaledb> server # [ 54.371267] systemd[1]: Listening on D-Bus System Message Bus Socket. vm-test-run-timescaledb> server # [ 54.377205] systemd[1]: Listening on Nix Daemon Socket. vm-test-run-timescaledb> server # [ 54.379513] systemd[1]: Listening on Hostname Service Socket. vm-test-run-timescaledb> server # [ 54.386716] systemd[1]: Reached target Socket Units. vm-test-run-timescaledb> server # [ 54.390712] systemd[1]: Reached target Basic System. vm-test-run-timescaledb> server # [ 54.406656] systemd[1]: Starting Import lastlog data into lastlog2 database... vm-test-run-timescaledb> server # [ 54.449675] systemd[1]: Starting Name Service Cache Daemon (nsncd)... vm-test-run-timescaledb> server # [ 54.514087] systemd[1]: Started Reset console on configuration changes. vm-test-run-timescaledb> server # [ 54.582442] systemd[1]: Starting resolvconf update... vm-test-run-timescaledb> server # [ 54.661386] systemd[1]: Starting D-Bus System Message Bus... vm-test-run-timescaledb> server # [ 55.796137] systemd[1]: Finished Import lastlog data into lastlog2 database. vm-test-run-timescaledb> server # [ 55.994045] systemd[1]: Started Name Service Cache Daemon (nsncd). vm-test-run-timescaledb> server # [ 56.007870] systemd[1]: Reached target Host and Network Name Lookups. vm-test-run-timescaledb> server # [ 56.019774] systemd[1]: Reached target User and Group Name Lookups. vm-test-run-timescaledb> server # [ 56.084503] nsncd[626]: Oct 26 08:10:31.400 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" vm-test-run-timescaledb> server # [ 56.104937] systemd[1]: Starting User Login Management... vm-test-run-timescaledb> server # [ 56.362167] dbus-daemon[629]: dbus[629]: Unknown username "systemd-timesync" in message bus configuration file vm-test-run-timescaledb> server # [ 56.826707] systemd[1]: Started D-Bus System Message Bus. vm-test-run-timescaledb> server # [ 57.771064] systemd-logind[647]: New seat seat0. vm-test-run-timescaledb> server # [ 57.819273] systemd[1]: Started User Login Management. vm-test-run-timescaledb> server # [ 57.881313] systemd[1]: Starting linger-users.service... vm-test-run-timescaledb> server # [ 58.069942] systemd[1]: Stopped target Host and Network Name Lookups. vm-test-run-timescaledb> server # [ 58.077936] systemd[1]: Stopping Host and Network Name Lookups... vm-test-run-timescaledb> server # [ 58.086320] systemd[1]: Stopped target User and Group Name Lookups. vm-test-run-timescaledb> server # [ 58.088588] systemd[1]: Stopping User and Group Name Lookups... vm-test-run-timescaledb> server # [ 58.101576] systemd[1]: Stopping Name Service Cache Daemon (nsncd)... vm-test-run-timescaledb> server # [ 58.145489] systemd[1]: nscd.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 58.175851] systemd[1]: Stopped Name Service Cache Daemon (nsncd). vm-test-run-timescaledb> server # [ 58.373411] systemd[1]: Starting Name Service Cache Daemon (nsncd)... vm-test-run-timescaledb> server # [ 58.590281] systemd[1]: linger-users.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 58.605348] systemd[1]: Finished linger-users.service. vm-test-run-timescaledb> server: Guest root shell did not produce any data yet... vm-test-run-timescaledb> server: To debug, enter the VM and run 'systemctl status backdoor.service'. vm-test-run-timescaledb> server # [ 59.144417] systemd[1]: Started Name Service Cache Daemon (nsncd). vm-test-run-timescaledb> server # [ 59.153689] systemd[1]: Reached target Host and Network Name Lookups. vm-test-run-timescaledb> server # [ 59.167949] nsncd[693]: Oct 26 08:10:34.588 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" vm-test-run-timescaledb> server # [ 59.189887] systemd[1]: Reached target User and Group Name Lookups. vm-test-run-timescaledb> server # [ 59.559163] systemd[1]: Finished resolvconf update. vm-test-run-timescaledb> server # [ 59.573910] systemd[1]: Reached target Preparation for Network. vm-test-run-timescaledb> server # [ 59.614637] systemd[1]: Starting DHCP Client... vm-test-run-timescaledb> server # [ 61.182459] dhcpcd[737]: dhcpcd-10.2.4 starting vm-test-run-timescaledb> server # [ 61.313112] dhcpcd[761]: dev: loaded udev vm-test-run-timescaledb> server # [ 61.675459] 8021q: 802.1Q VLAN Support v1.8 vm-test-run-timescaledb> server # [ 62.131553] cfg80211: Loading compiled-in X.509 certificates for regulatory database vm-test-run-timescaledb> server # [ 62.394494] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7' vm-test-run-timescaledb> server # [ 62.403810] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600' vm-test-run-timescaledb> server # [ 62.424462] platform regulatory.0: Direct firmware load for regulatory.db failed with error -2 vm-test-run-timescaledb> server # [ 62.431475] cfg80211: failed to load regulatory.db vm-test-run-timescaledb> server # [ 62.615566] systemd[1]: Found device /dev/hvc0. vm-test-run-timescaledb> server # [ 63.367318] 8021q: adding VLAN 0 to HW filter on device eth0 vm-test-run-timescaledb> server # [ 63.290735] dhcpcd[761]: eth0: waiting for carrier vm-test-run-timescaledb> server # [ 63.322921] dhcpcd[761]: eth0: carrier acquired vm-test-run-timescaledb> server # [ 63.437567] dhcpcd[761]: DUID 00:01:00:01:32:71:c7:7e:52:54:00:12:34:56 vm-test-run-timescaledb> server # [ 63.439944] dhcpcd[761]: eth0: IAID 00:12:34:56 vm-test-run-timescaledb> server # [ 63.446219] dhcpcd[761]: eth0: adding address fe80::5054:ff:fe12:3456 vm-test-run-timescaledb> server # [ 64.459402] systemd[1]: Found device /dev/ttyAMA0. vm-test-run-timescaledb> server # [ 64.498837] systemd[1]: Started backdoor.service. vm-test-run-timescaledb> server # [ 64.739660] dhcpcd[761]: eth0: soliciting a DHCP lease vm-test-run-timescaledb> server # [ 64.765605] dhcpcd[761]: eth0: offered 10.0.2.15 from 10.0.2.2 vm-test-run-timescaledb> server # [ 64.789013] dhcpcd[761]: eth0: probing address 10.0.2.15/24 vm-test-run-timescaledb> server # connecting to host... vm-test-run-timescaledb> server # [ 65.210982] (udev-worker)[780]: eth1: Config file /etc/systemd/network/40-eth1.link is applied to device based on potentially unpredictable interface name. vm-test-run-timescaledb> server # [ 65.229530] (udev-worker)[780]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-timescaledb> server # [ 65.262679] (udev-worker)[778]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-timescaledb> server: Guest shell says: b'Spawning backdoor root shell...\n' vm-test-run-timescaledb> server: connected to guest root shell vm-test-run-timescaledb> server: (connecting took 66.39 seconds) vm-test-run-timescaledb> server: (finished: waiting for the VM to finish booting, in 66.39 seconds) vm-test-run-timescaledb> server # [ 65.823005] dhcpcd[761]: eth0: soliciting an IPv6 router vm-test-run-timescaledb> server # [ 65.833891] dhcpcd[761]: eth0: Router Advertisement from fe80::2 vm-test-run-timescaledb> server # [ 65.838686] dhcpcd[761]: eth0: adding address fec0::5054:ff:fe12:3456/64 vm-test-run-timescaledb> server # [ 65.845797] dhcpcd[761]: eth0: adding route to fec0::/64 vm-test-run-timescaledb> server # [ 65.847936] dhcpcd[761]: eth0: adding default route via fe80::2 vm-test-run-timescaledb> server # [ 66.673977] systemd[1]: Found device Virtio network device. vm-test-run-timescaledb> server # [ 66.714307] dhcpcd[761]: eth0: IAID 00:12:34:56 vm-test-run-timescaledb> server # [ 66.722492] systemd[1]: Starting Address configuration of eth1... vm-test-run-timescaledb> server # [ 67.450836] dhcpcd[761]: eth0: soliciting a DHCP lease vm-test-run-timescaledb> server # [ 67.453845] dhcpcd[761]: eth0: offered 10.0.2.15 from 10.0.2.2 vm-test-run-timescaledb> server # [ 67.455067] dhcpcd[761]: eth0: probing address 10.0.2.15/24 vm-test-run-timescaledb> server # [ 67.616168] 8021q: adding VLAN 0 to HW filter on device eth1 vm-test-run-timescaledb> server # [ 67.558883] dhcpcd[761]: eth0: soliciting an IPv6 router vm-test-run-timescaledb> server # [ 67.815498] network-addresses-eth1-start[813]: adding address 192.168.1.1/24... done vm-test-run-timescaledb> server # [ 68.009265] network-addresses-eth1-start[813]: adding address 2001:db8:1::1/64... done vm-test-run-timescaledb> server # [ 68.295211] systemd[1]: Finished Address configuration of eth1. vm-test-run-timescaledb> server # [ 68.371790] systemd[1]: Starting Networking Setup... vm-test-run-timescaledb> server # [ 70.871873] systemd[1]: Finished Networking Setup. vm-test-run-timescaledb> server # [ 70.886113] systemd[1]: Reached target Network. vm-test-run-timescaledb> server # [ 70.920172] systemd[1]: Starting PostgreSQL Database Server... vm-test-run-timescaledb> server # [ 70.952125] systemd[1]: Starting Permit User Sessions... vm-test-run-timescaledb> server # [ 71.575559] systemd[1]: Finished Permit User Sessions. vm-test-run-timescaledb> server # [ 71.694621] systemd[1]: Started Getty on tty1. vm-test-run-timescaledb> server # [ 71.709677] systemd[1]: Reached target Login Prompts. vm-test-run-timescaledb> server # [ 72.201170] dhcpcd[761]: eth0: leased 10.0.2.15 for 86400 seconds vm-test-run-timescaledb> server # [ 72.204547] dhcpcd[761]: eth0: adding route to 10.0.2.0/24 vm-test-run-timescaledb> server # [ 72.221804] dhcpcd[761]: eth0: adding default route via 10.0.2.2 vm-test-run-timescaledb> server # [ 72.878452] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[914]: Initializing database at /var/lib/postgresql/data vm-test-run-timescaledb> server # [ 75.643714] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: The files belonging to this database system will be owned by user "postgres". vm-test-run-timescaledb> server # [ 75.665380] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: This user must also own the server process. vm-test-run-timescaledb> server # [ 75.746022] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: The database cluster will be initialized with locale "en_US.UTF-8". vm-test-run-timescaledb> server # [ 75.749772] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: The default database encoding has accordingly been set to "UTF8". vm-test-run-timescaledb> server # [ 75.751127] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: The default text search configuration will be set to "english". vm-test-run-timescaledb> server # [ 75.760893] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: Data page checksums are enabled. vm-test-run-timescaledb> server # [ 75.761698] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: fixing permissions on existing directory /var/lib/postgresql/data ... ok vm-test-run-timescaledb> server # [ 75.782916] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: creating subdirectories ... ok vm-test-run-timescaledb> server # [ 75.794980] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: selecting dynamic shared memory implementation ... posix vm-test-run-timescaledb> server # [ 76.166935] systemd[1]: Started DHCP Client. vm-test-run-timescaledb> server # [ 77.219203] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: selecting default max_connections ... 100 vm-test-run-timescaledb> server # [ 78.233641] systemd-logind[647]: Watching system buttons on /dev/input/event0 (gpio-keys) vm-test-run-timescaledb> server # [ 78.332256] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: selecting default shared_buffers ... 128MB vm-test-run-timescaledb> server # [ 87.605571] mousedev: PS/2 mouse device common for all mice vm-test-run-timescaledb> server # [ 90.082915] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: selecting default time zone ... UTC vm-test-run-timescaledb> server # [ 90.138146] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: creating configuration files ... ok vm-test-run-timescaledb> server # [ 91.845529] systemd-logind[647]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard) vm-test-run-timescaledb> server # [ 94.910194] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: running bootstrap script ... ok vm-test-run-timescaledb> server # [ 108.324438] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: performing post-bootstrap initialization ... ok vm-test-run-timescaledb> server # [ 112.161569] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: syncing data to disk ... ok vm-test-run-timescaledb> server # [ 112.166341] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: initdb: warning: enabling "trust" authentication for local connections vm-test-run-timescaledb> server # [ 112.170624] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: initdb: hint: You can change this by editing pg_hba.conf or using the option -A, or --auth-local and --auth-host, the next time you run initdb. vm-test-run-timescaledb> server # [ 112.185532] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: Success. You can now start the database server using: vm-test-run-timescaledb> server # [ 112.189901] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[932]: /nix/store/i45yhjwwac2d5ygyv0s5gbg2cgdjclf9-postgresql-and-plugins-15.19/bin/pg_ctl -D /var/lib/postgresql/data -l logfile start vm-test-run-timescaledb> server # [ 113.887508] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[914]: Validating PostgreSQL configuration... vm-test-run-timescaledb> server # [ 114.397034] ci6bbs3vc6x5hh0yh5fw5czk3xk2r269-postgresql-init[1370]: pg_stat_statements, pgaudit, plpgsql, plpgsql_check, pg_cron, pg_net, pgsodium, timescaledb, auto_explain, pg_tle, plan_filter, supabase_vault vm-test-run-timescaledb> server # [ 115.549084] postgres[1376]: 2026-10-26 08:11:30.990 UTC [1376] LOG: pgaudit extension initialized vm-test-run-timescaledb> server # [ 116.468830] postgres[1376]: 2026-10-26 08:11:31.931 UTC [1376] LOG: pgsodium primary server secret key loaded vm-test-run-timescaledb> server # [ 117.251805] postgres[1376]: 2026-10-26 08:11:32.697 UTC [1376] LOG: vault primary server secret key loaded vm-test-run-timescaledb> server # [ 117.875732] postgres[1376]: 2026-10-26 08:11:33.338 UTC [1376] LOG: starting PostgreSQL 15.19 on aarch64-unknown-linux-gnu, compiled by gcc (GCC) 15.2.0, 64-bit vm-test-run-timescaledb> server # [ 117.905711] postgres[1376]: 2026-10-26 08:11:33.367 UTC [1376] LOG: listening on IPv4 address "0.0.0.0", port 5432 vm-test-run-timescaledb> server # [ 117.911263] postgres[1376]: 2026-10-26 08:11:33.373 UTC [1376] LOG: listening on IPv6 address "::", port 5432 vm-test-run-timescaledb> server # [ 117.934848] postgres[1376]: 2026-10-26 08:11:33.396 UTC [1376] LOG: listening on Unix socket "/run/postgresql/.s.PGSQL.5432" vm-test-run-timescaledb> server # [ 118.093999] postgres[1415]: 2026-10-26 08:11:33.549 UTC [1415] LOG: database system was shut down at 2026-10-26 08:11:23 UTC vm-test-run-timescaledb> server # [ 118.323222] postgres[1376]: 2026-10-26 08:11:33.774 UTC [1376] LOG: database system is ready to accept connections vm-test-run-timescaledb> server # [ 118.419790] postgres[1418]: 2026-10-26 08:11:33.846 UTC [1418] LOG: TimescaleDB background worker launcher connected to shared catalogs vm-test-run-timescaledb> server # [ 118.454122] postgres[1419]: 2026-10-26 08:11:33.851 UTC [1419] FATAL: role "postgres" does not exist vm-test-run-timescaledb> server # [ 118.463237] systemd[1]: Started PostgreSQL Database Server. vm-test-run-timescaledb> server # [ 118.482327] systemd[1]: Starting Supabase Database Initialization... vm-test-run-timescaledb> server # [ 118.503787] postgres[1376]: 2026-10-26 08:11:33.966 UTC [1376] LOG: background worker "pg_net 0.20.4 worker" (PID 1419) exited with exit code 1 vm-test-run-timescaledb> server # [ 118.792052] postgres[1420]: 2026-10-26 08:11:34.239 UTC [1420] LOG: pg_cron scheduler started vm-test-run-timescaledb> server # [ 118.931750] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Waiting for PostgreSQL to be ready... vm-test-run-timescaledb> server # [ 119.674645] postgres[1444]: 2026-10-26 08:11:35.114 UTC [1444] FATAL: role "postgres" does not exist vm-test-run-timescaledb> server # [ 119.740025] postgres[1376]: 2026-10-26 08:11:35.198 UTC [1376] LOG: background worker "pg_net 0.20.4 worker" (PID 1444) exited with exit code 1 vm-test-run-timescaledb> server # [ 119.792047] postgres[1441]: ::1 2026-10-26 08:11:35.241 UTC [1441] root@root FATAL: role "root" does not exist vm-test-run-timescaledb> server # [ 119.867505] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: PostgreSQL is ready vm-test-run-timescaledb> server # [ 119.870803] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Creating postgres role... vm-test-run-timescaledb> server # [ 120.539185] postgres[1452]: ::1 2026-10-26 08:11:35.978 UTC [1452] supabase_admin@postgres LOG: statement: CREATE ROLE postgres SUPERUSER LOGIN; vm-test-run-timescaledb> server # [ 120.597211] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1446]: CREATE ROLE vm-test-run-timescaledb> server # [ 120.993408] postgres[1456]: ::1 2026-10-26 08:11:36.443 UTC [1456] supabase_admin@postgres LOG: statement: ALTER DATABASE postgres OWNER TO postgres; vm-test-run-timescaledb> server # [ 121.019908] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1454]: ALTER DATABASE vm-test-run-timescaledb> server # [ 121.076199] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000000-initial-schema.sql vm-test-run-timescaledb> server # [ 121.319848] postgres[1458]: ::1 2026-10-26 08:11:36.777 UTC [1458] postgres@postgres LOG: statement: create publication supabase_realtime; vm-test-run-timescaledb> server # [ 121.336354] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE PUBLICATION vm-test-run-timescaledb> server # [ 121.353719] postgres[1458]: ::1 2026-10-26 08:11:36.803 UTC [1458] postgres@postgres LOG: statement: alter user supabase_admin with superuser createdb createrole replication bypassrls; vm-test-run-timescaledb> server # [ 121.367081] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER ROLE vm-test-run-timescaledb> server # [ 121.368260] postgres[1458]: ::1 2026-10-26 08:11:36.832 UTC [1458] postgres@postgres LOG: statement: create user supabase_replication_admin with login replication; vm-test-run-timescaledb> server # [ 121.391413] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE ROLE vm-test-run-timescaledb> server # [ 121.392699] postgres[1458]: ::1 2026-10-26 08:11:36.856 UTC [1458] postgres@postgres LOG: statement: create user supabase_etl_admin with login replication bypassrls; vm-test-run-timescaledb> server # [ 121.406160] postgres[1458]: ::1 2026-10-26 08:11:36.870 UTC [1458] postgres@postgres LOG: statement: grant pg_read_all_data to supabase_etl_admin; vm-test-run-timescaledb> server # [ 121.407443] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE ROLE vm-test-run-timescaledb> server # [ 121.426926] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT ROLE vm-test-run-timescaledb> server # [ 121.427943] postgres[1458]: ::1 2026-10-26 08:11:36.891 UTC [1458] postgres@postgres LOG: statement: grant create on database postgres to supabase_etl_admin; vm-test-run-timescaledb> server # [ 121.447491] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT vm-test-run-timescaledb> server # [ 121.449682] postgres[1458]: ::1 2026-10-26 08:11:36.914 UTC [1458] postgres@postgres LOG: statement: create role supabase_read_only_user with login bypassrls; vm-test-run-timescaledb> server # [ 121.455468] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE ROLE vm-test-run-timescaledb> server # [ 121.457808] postgres[1458]: ::1 2026-10-26 08:11:36.922 UTC [1458] postgres@postgres LOG: statement: grant pg_read_all_data to supabase_read_only_user; vm-test-run-timescaledb> server # [ 121.469221] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT ROLE vm-test-run-timescaledb> server # [ 121.473988] postgres[1458]: ::1 2026-10-26 08:11:36.935 UTC [1458] postgres@postgres LOG: statement: create schema if not exists extensions; vm-test-run-timescaledb> server # [ 121.485231] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 121.491490] postgres[1458]: ::1 2026-10-26 08:11:36.955 UTC [1458] postgres@postgres LOG: statement: create extension if not exists "uuid-ossp" with schema extensions; vm-test-run-timescaledb> server # [ 124.130828] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE EXTENSION vm-test-run-timescaledb> server # [ 124.148363] postgres[1458]: ::1 2026-10-26 08:11:39.591 UTC [1458] postgres@postgres LOG: statement: create extension if not exists pgcrypto with schema extensions; vm-test-run-timescaledb> server # [ 124.879266] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE EXTENSION vm-test-run-timescaledb> server # [ 124.882618] postgres[1458]: ::1 2026-10-26 08:11:40.346 UTC [1458] postgres@postgres LOG: statement: create role anon nologin noinherit; vm-test-run-timescaledb> server # [ 124.888552] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE ROLE vm-test-run-timescaledb> server # [ 124.890653] postgres[1458]: ::1 2026-10-26 08:11:40.354 UTC [1458] postgres@postgres LOG: statement: create role authenticated nologin noinherit; vm-test-run-timescaledb> server # [ 124.897074] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE ROLE vm-test-run-timescaledb> server # [ 124.901585] postgres[1458]: ::1 2026-10-26 08:11:40.362 UTC [1458] postgres@postgres LOG: statement: create role service_role nologin noinherit bypassrls; vm-test-run-timescaledb> server # [ 124.906430] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE ROLE vm-test-run-timescaledb> server # [ 124.907953] postgres[1458]: ::1 2026-10-26 08:11:40.372 UTC [1458] postgres@postgres LOG: statement: create user authenticator noinherit; vm-test-run-timescaledb> server # [ 124.914904] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: CREATE ROLE vm-test-run-timescaledb> server # [ 124.918239] postgres[1458]: ::1 2026-10-26 08:11:40.380 UTC [1458] postgres@postgres LOG: statement: grant anon to authenticator; vm-test-run-timescaledb> server # [ 124.927048] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT ROLE vm-test-run-timescaledb> server # [ 124.930294] postgres[1458]: ::1 2026-10-26 08:11:40.392 UTC [1458] postgres@postgres LOG: statement: grant authenticated to authenticator; vm-test-run-timescaledb> server # [ 124.937458] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT ROLE vm-test-run-timescaledb> server # [ 124.941573] postgres[1458]: ::1 2026-10-26 08:11:40.405 UTC [1458] postgres@postgres LOG: statement: grant service_role to authenticator; vm-test-run-timescaledb> server # [ 124.949314] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT ROLE vm-test-run-timescaledb> server # [ 124.950529] postgres[1458]: ::1 2026-10-26 08:11:40.414 UTC [1458] postgres@postgres LOG: statement: grant supabase_admin to authenticator; vm-test-run-timescaledb> server # [ 124.958094] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT ROLE vm-test-run-timescaledb> server # [ 124.959016] postgres[1458]: ::1 2026-10-26 08:11:40.423 UTC [1458] postgres@postgres LOG: statement: grant usage on schema public to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 124.968039] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT vm-test-run-timescaledb> server # [ 124.972908] postgres[1458]: ::1 2026-10-26 08:11:40.434 UTC [1458] postgres@postgres LOG: statement: alter default privileges in schema public grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 124.985817] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 124.988160] postgres[1458]: ::1 2026-10-26 08:11:40.451 UTC [1458] postgres@postgres LOG: statement: alter default privileges in schema public grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 124.997798] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 124.998641] postgres[1458]: ::1 2026-10-26 08:11:40.462 UTC [1458] postgres@postgres LOG: statement: alter default privileges in schema public grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 125.006466] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 125.014352] postgres[1458]: ::1 2026-10-26 08:11:40.471 UTC [1458] postgres@postgres LOG: statement: grant usage on schema extensions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 125.023123] postgres[1458]: ::1 2026-10-26 08:11:40.481 UTC [1458] postgres@postgres LOG: statement: alter user supabase_admin SET search_path TO public, extensions; vm-test-run-timescaledb> server # [ 125.029403] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: GRANT vm-test-run-timescaledb> server # [ 125.037205] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER ROLE vm-test-run-timescaledb> server # [ 125.045688] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 125.046526] postgres[1458]: ::1 2026-10-26 08:11:40.498 UTC [1458] postgres@postgres LOG: statement: alter default privileges for user supabase_admin in schema public grant all vm-test-run-timescaledb> server # [ 125.050623] postgres[1458]: on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 125.053538] postgres[1458]: ::1 2026-10-26 08:11:40.506 UTC [1458] postgres@postgres LOG: statement: alter default privileges for user supabase_admin in schema public grant all vm-test-run-timescaledb> server # [ 125.054816] postgres[1458]: on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 125.057619] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 125.059311] postgres[1458]: ::1 2026-10-26 08:11:40.523 UTC [1458] postgres@postgres LOG: statement: alter default privileges for user supabase_admin in schema public grant all vm-test-run-timescaledb> server # [ 125.061824] postgres[1458]: on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 125.071035] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 125.071938] postgres[1458]: ::1 2026-10-26 08:11:40.535 UTC [1458] postgres@postgres LOG: statement: alter role anon set statement_timeout = '3s'; vm-test-run-timescaledb> server # [ 125.078702] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER ROLE vm-test-run-timescaledb> server # [ 125.083422] postgres[1458]: ::1 2026-10-26 08:11:40.545 UTC [1458] postgres@postgres LOG: statement: alter role authenticated set statement_timeout = '8s'; vm-test-run-timescaledb> server # [ 125.089789] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1457]: ALTER ROLE vm-test-run-timescaledb> server # [ 125.155798] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000001-auth-schema.sql vm-test-run-timescaledb> server # [ 125.586124] postgres[1492]: ::1 2026-10-26 08:11:41.017 UTC [1492] postgres@postgres LOG: statement: CREATE SCHEMA IF NOT EXISTS auth AUTHORIZATION supabase_admin; vm-test-run-timescaledb> server # [ 125.659124] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 125.669624] postgres[1492]: ::1 2026-10-26 08:11:41.128 UTC [1492] postgres@postgres LOG: statement: CREATE TABLE auth.users ( vm-test-run-timescaledb> server # [ 125.694292] postgres[1492]: instance_id uuid NULL, vm-test-run-timescaledb> server # [ 125.695361] postgres[1492]: id uuid NOT NULL UNIQUE, vm-test-run-timescaledb> server # [ 125.705237] postgres[1492]: aud varchar(255) NULL, vm-test-run-timescaledb> server # [ 125.707244] postgres[1492]: "role" varchar(255) NULL, vm-test-run-timescaledb> server # [ 125.721684] postgres[1492]: email varchar(255) NULL UNIQUE, vm-test-run-timescaledb> server # [ 125.728871] postgres[1492]: encrypted_password varchar(255) NULL, vm-test-run-timescaledb> server # [ 125.730518] postgres[1492]: confirmed_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.737780] postgres[1492]: invited_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.750487] postgres[1492]: confirmation_token varchar(255) NULL, vm-test-run-timescaledb> server # [ 125.757694] postgres[1492]: confirmation_sent_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.758739] postgres[1492]: recovery_token varchar(255) NULL, vm-test-run-timescaledb> server # [ 125.759599] postgres[1492]: recovery_sent_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.770061] postgres[1492]: email_change_token varchar(255) NULL, vm-test-run-timescaledb> server # [ 125.771864] postgres[1492]: email_change varchar(255) NULL, vm-test-run-timescaledb> server # [ 125.786241] postgres[1492]: email_change_sent_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.793254] postgres[1492]: last_sign_in_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.794003] postgres[1492]: raw_app_meta_data jsonb NULL, vm-test-run-timescaledb> server # [ 125.794881] postgres[1492]: raw_user_meta_data jsonb NULL, vm-test-run-timescaledb> server # [ 125.795202] postgres[1492]: is_super_admin bool NULL, vm-test-run-timescaledb> server # [ 125.795466] postgres[1492]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.799605] postgres[1492]: updated_at timestamptz NULL, vm-test-run-timescaledb> server # [ 125.807544] postgres[1492]: CONSTRAINT users_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 125.812987] postgres[1492]: ); vm-test-run-timescaledb> server # [ 126.037332] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE TABLE vm-test-run-timescaledb> server # [ 126.057252] postgres[1492]: ::1 2026-10-26 08:11:41.511 UTC [1492] postgres@postgres LOG: statement: CREATE INDEX users_instance_id_email_idx ON auth.users USING btree (instance_id, email); vm-test-run-timescaledb> server # [ 126.138762] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE INDEX vm-test-run-timescaledb> server # [ 126.146648] postgres[1492]: ::1 2026-10-26 08:11:41.606 UTC [1492] postgres@postgres LOG: statement: CREATE INDEX users_instance_id_idx ON auth.users USING btree (instance_id); vm-test-run-timescaledb> server # [ 126.181285] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE INDEX vm-test-run-timescaledb> server # [ 126.190344] postgres[1492]: ::1 2026-10-26 08:11:41.653 UTC [1492] postgres@postgres LOG: statement: comment on table auth.users is 'Auth: Stores user login data within a secure schema.'; vm-test-run-timescaledb> server # [ 126.202283] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: COMMENT vm-test-run-timescaledb> server # [ 126.203416] postgres[1492]: ::1 2026-10-26 08:11:41.667 UTC [1492] postgres@postgres LOG: statement: CREATE TABLE auth.refresh_tokens ( vm-test-run-timescaledb> server # [ 126.209354] postgres[1492]: instance_id uuid NULL, vm-test-run-timescaledb> server # [ 126.210750] postgres[1492]: id bigserial NOT NULL, vm-test-run-timescaledb> server # [ 126.217998] postgres[1492]: "token" varchar(255) NULL, vm-test-run-timescaledb> server # [ 126.218607] postgres[1492]: user_id varchar(255) NULL, vm-test-run-timescaledb> server # [ 126.219901] postgres[1492]: revoked bool NULL, vm-test-run-timescaledb> server # [ 126.226213] postgres[1492]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 126.229192] postgres[1492]: updated_at timestamptz NULL, vm-test-run-timescaledb> server # [ 126.230377] postgres[1492]: CONSTRAINT refresh_tokens_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 126.231057] postgres[1492]: ); vm-test-run-timescaledb> server # [ 126.342936] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE TABLE vm-test-run-timescaledb> server # [ 126.343874] postgres[1492]: ::1 2026-10-26 08:11:41.807 UTC [1492] postgres@postgres LOG: statement: CREATE INDEX refresh_tokens_instance_id_idx ON auth.refresh_tokens USING btree (instance_id); vm-test-run-timescaledb> server # [ 126.411918] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE INDEX vm-test-run-timescaledb> server # [ 126.419653] postgres[1492]: ::1 2026-10-26 08:11:41.883 UTC [1492] postgres@postgres LOG: statement: CREATE INDEX refresh_tokens_instance_id_user_id_idx ON auth.refresh_tokens USING btree (instance_id, user_id); vm-test-run-timescaledb> server # [ 126.455733] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE INDEX vm-test-run-timescaledb> server # [ 126.461509] postgres[1492]: ::1 2026-10-26 08:11:41.925 UTC [1492] postgres@postgres LOG: statement: CREATE INDEX refresh_tokens_token_idx ON auth.refresh_tokens USING btree (token); vm-test-run-timescaledb> server # [ 126.497519] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE INDEX vm-test-run-timescaledb> server # [ 126.499104] postgres[1492]: ::1 2026-10-26 08:11:41.958 UTC [1492] postgres@postgres LOG: statement: comment on table auth.refresh_tokens is 'Auth: Store of tokens used to refresh JWT tokens once they expire.'; vm-test-run-timescaledb> server # [ 126.509366] postgres[1492]: ::1 2026-10-26 08:11:41.970 UTC [1492] postgres@postgres LOG: statement: CREATE TABLE auth.instances ( vm-test-run-timescaledb> server # [ 126.522539] postgres[1492]: id uuid NOT NULL, vm-test-run-timescaledb> server # [ 126.523404] postgres[1492]: uuid uuid NULL, vm-test-run-timescaledb> server # [ 126.524218] postgres[1492]: raw_base_config text NULL, vm-test-run-timescaledb> server # [ 126.535451] postgres[1492]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 126.537105] postgres[1492]: updated_at timestamptz NULL, vm-test-run-timescaledb> server # [ 126.537508] postgres[1492]: CONSTRAINT instances_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 126.537811] postgres[1492]: ); vm-test-run-timescaledb> server # [ 126.538770] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: COMMENT vm-test-run-timescaledb> server # [ 126.575592] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE TABLE vm-test-run-timescaledb> server # [ 126.595758] postgres[1492]: ::1 2026-10-26 08:11:42.042 UTC [1492] postgres@postgres LOG: statement: comment on table auth.instances is 'Auth: Manages users across multiple sites.'; vm-test-run-timescaledb> server # [ 126.605560] postgres[1492]: ::1 2026-10-26 08:11:42.053 UTC [1492] postgres@postgres LOG: statement: CREATE TABLE auth.audit_log_entries ( vm-test-run-timescaledb> server # [ 126.606476] postgres[1492]: instance_id uuid NULL, vm-test-run-timescaledb> server # [ 126.606836] postgres[1492]: id uuid NOT NULL, vm-test-run-timescaledb> server # [ 126.607399] postgres[1492]: payload json NULL, vm-test-run-timescaledb> server # [ 126.608224] postgres[1492]: created_at timestamptz NULL, vm-test-run-timescaledb> server # [ 126.614547] postgres[1492]: CONSTRAINT audit_log_entries_pkey PRIMARY KEY (id) vm-test-run-timescaledb> server # [ 126.618064] postgres[1492]: ); vm-test-run-timescaledb> server # [ 126.620658] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: COMMENT vm-test-run-timescaledb> server # [ 126.672816] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE TABLE vm-test-run-timescaledb> server # [ 126.673695] postgres[1492]: ::1 2026-10-26 08:11:42.126 UTC [1492] postgres@postgres LOG: statement: CREATE INDEX audit_logs_instance_id_idx ON auth.audit_log_entries USING btree (instance_id); vm-test-run-timescaledb> server # [ 126.696999] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE INDEX vm-test-run-timescaledb> server # [ 126.702947] postgres[1492]: ::1 2026-10-26 08:11:42.164 UTC [1492] postgres@postgres LOG: statement: comment on table auth.audit_log_entries is 'Auth: Audit trail for user actions.'; vm-test-run-timescaledb> server # [ 126.714621] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: COMMENT vm-test-run-timescaledb> server # [ 126.715874] postgres[1492]: ::1 2026-10-26 08:11:42.177 UTC [1492] postgres@postgres LOG: statement: CREATE TABLE auth.schema_migrations ( vm-test-run-timescaledb> server # [ 126.721388] postgres[1492]: "version" varchar(255) NOT NULL, vm-test-run-timescaledb> server # [ 126.722605] postgres[1492]: CONSTRAINT schema_migrations_pkey PRIMARY KEY ("version") vm-test-run-timescaledb> server # [ 126.723559] postgres[1492]: ); vm-test-run-timescaledb> server # [ 126.757504] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE TABLE vm-test-run-timescaledb> server # [ 126.758975] postgres[1492]: ::1 2026-10-26 08:11:42.219 UTC [1492] postgres@postgres LOG: statement: comment on table auth.schema_migrations is 'Auth: Manages updates to the auth system.'; vm-test-run-timescaledb> server # [ 126.769919] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: COMMENT vm-test-run-timescaledb> server # [ 126.786338] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: INSERT 0 7 vm-test-run-timescaledb> server # [ 126.790593] postgres[1492]: ::1 2026-10-26 08:11:42.254 UTC [1492] postgres@postgres LOG: statement: create or replace function auth.uid() returns uuid as $$ vm-test-run-timescaledb> server # [ 126.791928] postgres[1492]: select nullif(current_setting('request.jwt.claim.sub', true), '')::uuid; vm-test-run-timescaledb> server # [ 126.799016] postgres[1492]: $$ language sql stable; vm-test-run-timescaledb> server # [ 126.810138] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 126.811216] postgres[1492]: ::1 2026-10-26 08:11:42.274 UTC [1492] postgres@postgres LOG: statement: create or replace function auth.role() returns text as $$ vm-test-run-timescaledb> server # [ 126.812345] postgres[1492]: select nullif(current_setting('request.jwt.claim.role', true), '')::text; vm-test-run-timescaledb> server # [ 126.818313] postgres[1492]: $$ language sql stable; vm-test-run-timescaledb> server # [ 126.830109] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 126.834845] postgres[1492]: ::1 2026-10-26 08:11:42.299 UTC [1492] postgres@postgres LOG: statement: create or replace function auth.email() returns text as $$ vm-test-run-timescaledb> server # [ 126.843516] postgres[1492]: select nullif(current_setting('request.jwt.claim.email', true), '')::text; vm-test-run-timescaledb> server # [ 126.845741] postgres[1492]: $$ language sql stable; vm-test-run-timescaledb> server # [ 126.850617] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 126.851663] postgres[1492]: ::1 2026-10-26 08:11:42.315 UTC [1492] postgres@postgres LOG: statement: GRANT USAGE ON SCHEMA auth TO anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 126.867567] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: GRANT vm-test-run-timescaledb> server # [ 126.869461] postgres[1492]: ::1 2026-10-26 08:11:42.331 UTC [1492] postgres@postgres LOG: statement: CREATE USER supabase_auth_admin NOINHERIT CREATEROLE LOGIN NOREPLICATION; vm-test-run-timescaledb> server # [ 126.877678] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: CREATE ROLE vm-test-run-timescaledb> server # [ 126.883810] postgres[1492]: ::1 2026-10-26 08:11:42.344 UTC [1492] postgres@postgres LOG: statement: GRANT ALL PRIVILEGES ON SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 126.889834] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: GRANT vm-test-run-timescaledb> server # [ 126.891344] postgres[1492]: ::1 2026-10-26 08:11:42.355 UTC [1492] postgres@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL TABLES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 126.906130] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: GRANT vm-test-run-timescaledb> server # [ 126.907846] postgres[1492]: ::1 2026-10-26 08:11:42.372 UTC [1492] postgres@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL SEQUENCES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 126.916067] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: GRANT vm-test-run-timescaledb> server # [ 126.917826] postgres[1492]: ::1 2026-10-26 08:11:42.382 UTC [1492] postgres@postgres LOG: statement: ALTER USER supabase_auth_admin SET search_path = "auth"; vm-test-run-timescaledb> server # [ 126.926116] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: ALTER ROLE vm-test-run-timescaledb> server # [ 126.927648] postgres[1492]: ::1 2026-10-26 08:11:42.391 UTC [1492] postgres@postgres LOG: statement: ALTER table "auth".users OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 126.942336] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: ALTER TABLE vm-test-run-timescaledb> server # [ 126.949353] postgres[1492]: ::1 2026-10-26 08:11:42.409 UTC [1492] postgres@postgres LOG: statement: ALTER table "auth".refresh_tokens OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 126.958454] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: ALTER TABLE vm-test-run-timescaledb> server # [ 126.961113] postgres[1492]: ::1 2026-10-26 08:11:42.425 UTC [1492] postgres@postgres LOG: statement: ALTER table "auth".audit_log_entries OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 126.981334] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: ALTER TABLE vm-test-run-timescaledb> server # [ 126.983082] postgres[1492]: ::1 2026-10-26 08:11:42.443 UTC [1492] postgres@postgres LOG: statement: ALTER table "auth".instances OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 126.991217] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: ALTER TABLE vm-test-run-timescaledb> server # [ 126.992081] postgres[1492]: ::1 2026-10-26 08:11:42.456 UTC [1492] postgres@postgres LOG: statement: ALTER table "auth".schema_migrations OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 127.002794] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1489]: ALTER TABLE vm-test-run-timescaledb> server # [ 127.063189] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000002-storage-schema.sql vm-test-run-timescaledb> server # [ 127.399799] postgres[1517]: ::1 2026-10-26 08:11:42.859 UTC [1517] postgres@postgres LOG: statement: CREATE SCHEMA IF NOT EXISTS storage AUTHORIZATION supabase_admin; vm-test-run-timescaledb> server # [ 127.445686] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1513]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 127.446922] postgres[1517]: ::1 2026-10-26 08:11:42.888 UTC [1517] postgres@postgres LOG: statement: CREATE USER supabase_storage_admin NOINHERIT CREATEROLE LOGIN NOREPLICATION; vm-test-run-timescaledb> server # [ 127.448086] postgres[1517]: ::1 2026-10-26 08:11:42.906 UTC [1517] postgres@postgres LOG: statement: ALTER USER supabase_storage_admin SET search_path = "storage"; vm-test-run-timescaledb> server # [ 127.450825] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1513]: CREATE ROLE vm-test-run-timescaledb> server # [ 127.460012] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1513]: ALTER ROLE vm-test-run-timescaledb> server # [ 127.468839] postgres[1517]: ::1 2026-10-26 08:11:42.928 UTC [1517] postgres@postgres LOG: statement: GRANT CREATE ON DATABASE postgres TO supabase_storage_admin; vm-test-run-timescaledb> server # [ 127.489414] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1513]: GRANT vm-test-run-timescaledb> server # [ 127.530206] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1513]: DO vm-test-run-timescaledb> server # [ 127.578046] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running init-script: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/init-scripts/00000000000003-post-setup.sql vm-test-run-timescaledb> server # [ 127.886899] postgres[1520]: ::1 2026-10-26 08:11:43.344 UTC [1520] postgres@postgres LOG: statement: ALTER ROLE supabase_admin SET search_path TO "\$user",public,auth,extensions; vm-test-run-timescaledb> server # [ 127.910965] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: ALTER ROLE vm-test-run-timescaledb> server # [ 127.920947] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: ALTER ROLE vm-test-run-timescaledb> server # [ 127.921883] postgres[1520]: ::1 2026-10-26 08:11:43.370 UTC [1520] postgres@postgres LOG: statement: ALTER ROLE postgres SET search_path TO "\$user",public,extensions; vm-test-run-timescaledb> server # [ 127.923413] postgres[1520]: ::1 2026-10-26 08:11:43.380 UTC [1520] postgres@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_cron_access() vm-test-run-timescaledb> server # [ 127.924105] postgres[1520]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 127.932641] postgres[1520]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 127.937860] postgres[1520]: AS $$ vm-test-run-timescaledb> server # [ 127.938475] postgres[1520]: DECLARE vm-test-run-timescaledb> server # [ 127.939200] postgres[1520]: schema_is_cron bool; vm-test-run-timescaledb> server # [ 127.939806] postgres[1520]: BEGIN vm-test-run-timescaledb> server # [ 127.951783] postgres[1520]: schema_is_cron = ( vm-test-run-timescaledb> server # [ 127.952538] postgres[1520]: SELECT n.nspname = 'cron' vm-test-run-timescaledb> server # [ 127.954105] postgres[1520]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 127.954965] postgres[1520]: LEFT JOIN pg_catalog.pg_namespace AS n vm-test-run-timescaledb> server # [ 127.960194] postgres[1520]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 127.975404] postgres[1520]: ); vm-test-run-timescaledb> server # [ 127.981115] postgres[1520]: vm-test-run-timescaledb> server # [ 127.988128] postgres[1520]: IF schema_is_cron vm-test-run-timescaledb> server # [ 127.991812] postgres[1520]: THEN vm-test-run-timescaledb> server # [ 127.993734] postgres[1520]: grant usage on schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 127.994516] postgres[1520]: vm-test-run-timescaledb> server # [ 127.995328] postgres[1520]: alter default privileges in schema cron grant all on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 127.997028] postgres[1520]: alter default privileges in schema cron grant all on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 127.998049] postgres[1520]: alter default privileges in schema cron grant all on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 127.999411] postgres[1520]: vm-test-run-timescaledb> server # [ 128.002683] postgres[1520]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 128.003771] postgres[1520]: on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 128.014951] postgres[1520]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 128.015632] postgres[1520]: on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 128.016078] postgres[1520]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 128.025738] postgres[1520]: on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 128.026692] postgres[1520]: vm-test-run-timescaledb> server # [ 128.027068] postgres[1520]: grant all privileges on all tables in schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 128.027494] postgres[1520]: vm-test-run-timescaledb> server # [ 128.027927] postgres[1520]: END IF; vm-test-run-timescaledb> server # [ 128.039117] postgres[1520]: vm-test-run-timescaledb> server # [ 128.053481] postgres[1520]: END; vm-test-run-timescaledb> server # [ 128.055371] postgres[1520]: $$; vm-test-run-timescaledb> server # [ 128.062620] postgres[1520]: ::1 2026-10-26 08:11:43.412 UTC [1520] postgres@postgres LOG: statement: CREATE EVENT TRIGGER issue_pg_cron_access ON ddl_command_end WHEN TAG in ('CREATE SCHEMA') vm-test-run-timescaledb> server # [ 128.063590] postgres[1520]: EXECUTE PROCEDURE extensions.grant_pg_cron_access(); vm-test-run-timescaledb> server # [ 128.064922] postgres[1520]: ::1 2026-10-26 08:11:43.430 UTC [1520] postgres@postgres LOG: statement: COMMENT ON FUNCTION extensions.grant_pg_cron_access IS 'Grants access to pg_cron'; vm-test-run-timescaledb> server # [ 128.066472] postgres[1520]: ::1 2026-10-26 08:11:43.456 UTC [1520] postgres@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_net_access() vm-test-run-timescaledb> server # [ 128.067250] postgres[1520]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 128.068141] postgres[1520]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 128.078148] postgres[1520]: AS $$ vm-test-run-timescaledb> server # [ 128.079246] postgres[1520]: BEGIN vm-test-run-timescaledb> server # [ 128.079955] postgres[1520]: IF EXISTS ( vm-test-run-timescaledb> server # [ 128.083448] postgres[1520]: SELECT 1 vm-test-run-timescaledb> server # [ 128.083875] postgres[1520]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 128.085118] postgres[1520]: JOIN pg_extension AS ext vm-test-run-timescaledb> server # [ 128.086115] postgres[1520]: ON ev.objid = ext.oid vm-test-run-timescaledb> server # [ 128.086794] postgres[1520]: WHERE ext.extname = 'pg_net' vm-test-run-timescaledb> server # [ 128.087194] postgres[1520]: ) vm-test-run-timescaledb> server # [ 128.088178] postgres[1520]: THEN vm-test-run-timescaledb> server # [ 128.090943] postgres[1520]: IF NOT EXISTS ( vm-test-run-timescaledb> server # [ 128.091450] postgres[1520]: SELECT 1 vm-test-run-timescaledb> server # [ 128.092184] postgres[1520]: FROM pg_roles vm-test-run-timescaledb> server # [ 128.094714] postgres[1520]: WHERE rolname = 'supabase_functions_admin' vm-test-run-timescaledb> server # [ 128.095552] postgres[1520]: ) vm-test-run-timescaledb> server # [ 128.098150] postgres[1520]: THEN vm-test-run-timescaledb> server # [ 128.098678] postgres[1520]: CREATE USER supabase_functions_admin NOINHERIT CREATEROLE LOGIN NOREPLICATION; vm-test-run-timescaledb> server # [ 128.099200] postgres[1520]: END IF; vm-test-run-timescaledb> server # [ 128.099899] postgres[1520]: vm-test-run-timescaledb> server # [ 128.100160] postgres[1520]: GRANT USAGE ON SCHEMA net TO supabase_functions_admin, postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 128.101227] postgres[1520]: vm-test-run-timescaledb> server # [ 128.101728] postgres[1520]: ALTER function net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) SECURITY DEFINER; vm-test-run-timescaledb> server # [ 128.102167] postgres[1520]: ALTER function net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) SECURITY DEFINER; vm-test-run-timescaledb> server # [ 128.109056] postgres[1520]: vm-test-run-timescaledb> server # [ 128.109532] postgres[1520]: ALTER function net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) SET search_path = net; vm-test-run-timescaledb> server # [ 128.110564] postgres[1520]: ALTER function net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) SET search_path = net; vm-test-run-timescaledb> server # [ 128.111960] postgres[1520]: vm-test-run-timescaledb> server # [ 128.113878] postgres[1520]: REVOKE ALL ON FUNCTION net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) FROM PUBLIC; vm-test-run-timescaledb> server # [ 128.115410] postgres[1520]: REVOKE ALL ON FUNCTION net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) FROM PUBLIC; vm-test-run-timescaledb> server # [ 128.121910] postgres[1520]: vm-test-run-timescaledb> server # [ 128.122709] postgres[1520]: GRANT EXECUTE ON FUNCTION net.http_get(url text, params jsonb, headers jsonb, timeout_milliseconds integer) TO supabase_functions_admin, postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 128.125917] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 128.126686] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 128.127420] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: COMMENT vm-test-run-timescaledb> server # [ 128.128257] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 128.131968] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: COMMENT vm-test-run-timescaledb> server # [ 128.134304] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: DO vm-test-run-timescaledb> server # [ 128.135470] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: CREATE ROLE vm-test-run-timescaledb> server # [ 128.137242] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.137629] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.139161] postgres[1520]: GRANT EXECUTE ON FUNCTION net.http_post(url text, body jsonb, params jsonb, headers jsonb, timeout_milliseconds integer) TO supabase_functions_admin, postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 128.144132] postgres[1520]: END IF; vm-test-run-timescaledb> server # [ 128.147241] postgres[1520]: END; vm-test-run-timescaledb> server # [ 128.147663] postgres[1520]: $$; vm-test-run-timescaledb> server # [ 128.147916] postgres[1520]: ::1 2026-10-26 08:11:43.483 UTC [1520] postgres@postgres LOG: statement: COMMENT ON FUNCTION extensions.grant_pg_net_access IS 'Grants access to pg_net'; vm-test-run-timescaledb> server # [ 128.150787] postgres[1520]: ::1 2026-10-26 08:11:43.532 UTC [1520] postgres@postgres LOG: statement: CREATE ROLE dashboard_user NOSUPERUSER CREATEDB CREATEROLE REPLICATION; vm-test-run-timescaledb> server # [ 128.151610] postgres[1520]: ::1 2026-10-26 08:11:43.547 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON DATABASE postgres TO dashboard_user; vm-test-run-timescaledb> server # [ 128.153274] postgres[1520]: ::1 2026-10-26 08:11:43.569 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 128.155292] postgres[1520]: ::1 2026-10-26 08:11:43.583 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 128.155874] postgres[1520]: ::1 2026-10-26 08:11:43.598 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 128.158196] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.158860] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.159176] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.159551] postgres[1520]: ::1 2026-10-26 08:11:43.614 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 128.162089] postgres[1520]: ::1 2026-10-26 08:11:43.622 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 128.169789] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.170665] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.171267] postgres[1520]: ::1 2026-10-26 08:11:43.631 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 128.171906] postgres[1520]: ::1 2026-10-26 08:11:43.633 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA auth TO dashboard_user; vm-test-run-timescaledb> server # [ 128.185061] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.186218] postgres[1520]: ::1 2026-10-26 08:11:43.649 UTC [1520] postgres@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA extensions TO dashboard_user; vm-test-run-timescaledb> server # [ 128.229307] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: GRANT vm-test-run-timescaledb> server # [ 128.243248] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1519]: DO vm-test-run-timescaledb> server # [ 128.317076] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running pgbouncer auth schema... vm-test-run-timescaledb> server # [ 128.556236] postgres[1522]: ::1 2026-10-26 08:11:44.014 UTC [1522] postgres@postgres LOG: statement: CREATE USER pgbouncer; vm-test-run-timescaledb> server # [ 128.580161] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE ROLE vm-test-run-timescaledb> server # [ 128.586578] postgres[1522]: ::1 2026-10-26 08:11:44.041 UTC [1522] postgres@postgres LOG: statement: REVOKE ALL PRIVILEGES ON SCHEMA public FROM pgbouncer; vm-test-run-timescaledb> server # [ 128.588017] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: REVOKE vm-test-run-timescaledb> server # [ 128.594862] postgres[1522]: ::1 2026-10-26 08:11:44.058 UTC [1522] postgres@postgres LOG: statement: CREATE SCHEMA pgbouncer AUTHORIZATION pgbouncer; vm-test-run-timescaledb> server # [ 128.711618] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 128.717157] postgres[1522]: ::1 2026-10-26 08:11:44.178 UTC [1522] postgres@postgres LOG: statement: CREATE OR REPLACE FUNCTION pgbouncer.get_auth(p_usename TEXT) vm-test-run-timescaledb> server # [ 128.718405] postgres[1522]: RETURNS TABLE(username TEXT, password TEXT) AS vm-test-run-timescaledb> server # [ 128.727798] postgres[1522]: $$ vm-test-run-timescaledb> server # [ 128.730734] postgres[1522]: BEGIN vm-test-run-timescaledb> server # [ 128.731255] postgres[1522]: RAISE WARNING 'PgBouncer auth request: %', p_usename; vm-test-run-timescaledb> server # [ 128.731611] postgres[1522]: vm-test-run-timescaledb> server # [ 128.731856] postgres[1522]: RETURN QUERY vm-test-run-timescaledb> server # [ 128.733189] postgres[1522]: SELECT usename::TEXT, passwd::TEXT FROM pg_catalog.pg_shadow vm-test-run-timescaledb> server # [ 128.734405] postgres[1522]: WHERE usename = p_usename; vm-test-run-timescaledb> server # [ 128.735407] postgres[1522]: END; vm-test-run-timescaledb> server # [ 128.736385] postgres[1522]: $$ LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 128.741178] postgres[1522]: SET search_path = '' vm-test-run-timescaledb> server # [ 128.742146] postgres[1522]: SECURITY DEFINER; vm-test-run-timescaledb> server # [ 128.742900] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 128.750453] postgres[1522]: ::1 2026-10-26 08:11:44.214 UTC [1522] postgres@postgres LOG: statement: REVOKE ALL ON FUNCTION pgbouncer.get_auth(p_usename TEXT) FROM PUBLIC; vm-test-run-timescaledb> server # [ 128.759449] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: REVOKE vm-test-run-timescaledb> server # [ 128.760346] postgres[1522]: ::1 2026-10-26 08:11:44.224 UTC [1522] postgres@postgres LOG: statement: GRANT EXECUTE ON FUNCTION pgbouncer.get_auth(p_usename TEXT) TO pgbouncer; vm-test-run-timescaledb> server # [ 128.772471] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1521]: GRANT vm-test-run-timescaledb> server # [ 128.825764] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running stat extension... vm-test-run-timescaledb> server # [ 129.298085] postgres[1537]: ::1 2026-10-26 08:11:44.748 UTC [1537] postgres@postgres LOG: statement: CREATE SCHEMA IF NOT exists extensions; vm-test-run-timescaledb> server # [ 129.334594] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1530]: psql:/nix/store/vgajqkksdcv2cbrba1cgngx3rrkdykp1-stat-extension.sql:1: NOTICE: schema "extensions" already exists, skipping vm-test-run-timescaledb> server # [ 129.365909] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1530]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 129.377834] postgres[1537]: ::1 2026-10-26 08:11:44.839 UTC [1537] postgres@postgres LOG: statement: CREATE EXTENSION IF NOT EXISTS pg_stat_statements with schema extensions; vm-test-run-timescaledb> server # [ 130.631959] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1530]: CREATE EXTENSION vm-test-run-timescaledb> server # [ 130.702172] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/10000000000000_demote-postgres.sql vm-test-run-timescaledb> server # [ 130.938611] postgres[1550]: ::1 2026-10-26 08:11:46.392 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON DATABASE postgres TO postgres; vm-test-run-timescaledb> server # [ 130.950874] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 130.951634] postgres[1550]: ::1 2026-10-26 08:11:46.409 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 130.958181] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 130.958950] postgres[1550]: ::1 2026-10-26 08:11:46.423 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 130.968871] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 130.970833] postgres[1550]: ::1 2026-10-26 08:11:46.430 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 130.979118] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 130.985180] postgres[1550]: ::1 2026-10-26 08:11:46.446 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 130.992789] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 130.995935] postgres[1550]: ::1 2026-10-26 08:11:46.460 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 131.010142] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 131.020064] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 131.026031] postgres[1550]: ::1 2026-10-26 08:11:46.478 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 131.027666] postgres[1550]: ::1 2026-10-26 08:11:46.481 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 131.050934] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 131.055498] postgres[1550]: ::1 2026-10-26 08:11:46.519 UTC [1550] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA extensions TO postgres; vm-test-run-timescaledb> server # [ 131.111468] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: GRANT vm-test-run-timescaledb> server # [ 131.175553] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: DO vm-test-run-timescaledb> server # [ 131.177818] postgres[1550]: ::1 2026-10-26 08:11:46.641 UTC [1550] supabase_admin@postgres LOG: statement: ALTER ROLE postgres NOSUPERUSER CREATEDB CREATEROLE LOGIN REPLICATION BYPASSRLS; vm-test-run-timescaledb> server # [ 131.194843] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1549]: ALTER ROLE vm-test-run-timescaledb> server # [ 131.257770] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211115181400_update-auth-permissions.sql vm-test-run-timescaledb> server # [ 131.670069] postgres[1556]: ::1 2026-10-26 08:11:47.126 UTC [1556] supabase_admin@postgres LOG: statement: GRANT ALL PRIVILEGES ON SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.699129] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 131.725466] postgres[1556]: ::1 2026-10-26 08:11:47.152 UTC [1556] supabase_admin@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL TABLES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.726708] postgres[1556]: ::1 2026-10-26 08:11:47.182 UTC [1556] supabase_admin@postgres LOG: statement: GRANT ALL PRIVILEGES ON ALL SEQUENCES IN SCHEMA auth TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.727872] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 131.738250] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 131.739593] postgres[1556]: ::1 2026-10-26 08:11:47.203 UTC [1556] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".users OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.756929] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER TABLE vm-test-run-timescaledb> server # [ 131.772006] postgres[1556]: ::1 2026-10-26 08:11:47.221 UTC [1556] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".refresh_tokens OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.790895] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER TABLE vm-test-run-timescaledb> server # [ 131.809108] postgres[1556]: ::1 2026-10-26 08:11:47.265 UTC [1556] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".audit_log_entries OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.826217] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER TABLE vm-test-run-timescaledb> server # [ 131.841515] postgres[1556]: ::1 2026-10-26 08:11:47.298 UTC [1556] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".instances OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.860465] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER TABLE vm-test-run-timescaledb> server # [ 131.873703] postgres[1556]: ::1 2026-10-26 08:11:47.322 UTC [1556] supabase_admin@postgres LOG: statement: ALTER table IF EXISTS "auth".schema_migrations OWNER TO supabase_auth_admin; vm-test-run-timescaledb> server # [ 131.875825] postgres[1556]: ::1 2026-10-26 08:11:47.332 UTC [1556] supabase_admin@postgres LOG: statement: GRANT USAGE ON SCHEMA auth TO postgres; vm-test-run-timescaledb> server # [ 131.890615] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER TABLE vm-test-run-timescaledb> server # [ 131.891272] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 131.892322] postgres[1556]: ::1 2026-10-26 08:11:47.350 UTC [1556] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA auth TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 131.915715] postgres[1556]: ::1 2026-10-26 08:11:47.372 UTC [1556] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA auth TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 131.929134] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 131.930228] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 131.931485] postgres[1556]: ::1 2026-10-26 08:11:47.394 UTC [1556] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA auth TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 131.948374] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: GRANT vm-test-run-timescaledb> server # [ 131.950283] postgres[1556]: ::1 2026-10-26 08:11:47.414 UTC [1556] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_auth_admin IN SCHEMA auth GRANT ALL ON TABLES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 131.989056] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 131.990888] postgres[1556]: ::1 2026-10-26 08:11:47.448 UTC [1556] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_auth_admin IN SCHEMA auth GRANT ALL ON SEQUENCES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 132.029182] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 132.043834] postgres[1556]: ::1 2026-10-26 08:11:47.499 UTC [1556] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_auth_admin IN SCHEMA auth GRANT ALL ON ROUTINES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 132.052141] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1555]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 132.133267] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211118015519_create-realtime-schema.sql vm-test-run-timescaledb> server # [ 132.587272] postgres[1572]: ::1 2026-10-26 08:11:48.018 UTC [1572] supabase_admin@postgres LOG: statement: CREATE SCHEMA IF NOT EXISTS realtime; vm-test-run-timescaledb> server # [ 132.639144] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1566]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 132.657995] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211122051245_update-realtime-permissions.sql vm-test-run-timescaledb> server # [ 132.988309] postgres[1580]: ::1 2026-10-26 08:11:48.446 UTC [1580] supabase_admin@postgres LOG: statement: GRANT USAGE ON SCHEMA realtime TO postgres; vm-test-run-timescaledb> server # [ 133.009775] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1578]: GRANT vm-test-run-timescaledb> server # [ 133.011086] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1578]: GRANT vm-test-run-timescaledb> server # [ 133.011543] postgres[1580]: ::1 2026-10-26 08:11:48.464 UTC [1580] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL TABLES IN SCHEMA realtime TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 133.011964] postgres[1580]: ::1 2026-10-26 08:11:48.473 UTC [1580] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL SEQUENCES IN SCHEMA realtime TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 133.021938] postgres[1580]: ::1 2026-10-26 08:11:48.483 UTC [1580] supabase_admin@postgres LOG: statement: GRANT ALL ON ALL ROUTINES IN SCHEMA realtime TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 133.023073] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1578]: GRANT vm-test-run-timescaledb> server # [ 133.029873] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1578]: GRANT vm-test-run-timescaledb> server # [ 133.078733] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211124212715_update-auth-owner.sql vm-test-run-timescaledb> server # [ 133.522967] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: DO vm-test-run-timescaledb> server # [ 133.535312] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: DO vm-test-run-timescaledb> server # [ 133.553260] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1583]: DO vm-test-run-timescaledb> server # [ 133.612347] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20211130151719_update-realtime-permissions.sql vm-test-run-timescaledb> server # [ 133.936441] postgres[1588]: ::1 2026-10-26 08:11:49.392 UTC [1588] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_admin IN SCHEMA realtime GRANT ALL ON TABLES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 133.952989] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1587]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 133.958728] postgres[1588]: ::1 2026-10-26 08:11:49.415 UTC [1588] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_admin IN SCHEMA realtime GRANT ALL ON SEQUENCES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 133.966460] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1587]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 133.967944] postgres[1588]: ::1 2026-10-26 08:11:49.427 UTC [1588] supabase_admin@postgres LOG: statement: ALTER DEFAULT PRIVILEGES FOR ROLE supabase_admin IN SCHEMA realtime GRANT ALL ON ROUTINES TO postgres, dashboard_user; vm-test-run-timescaledb> server # [ 133.983537] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1587]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 134.007259] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220118070449_enable-safeupdate-postgrest.sql vm-test-run-timescaledb> server # [ 134.279164] postgres[1590]: ::1 2026-10-26 08:11:49.740 UTC [1590] supabase_admin@postgres LOG: statement: ALTER ROLE authenticator SET session_preload_libraries = 'safeupdate'; vm-test-run-timescaledb> server # [ 134.299414] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1589]: ALTER ROLE vm-test-run-timescaledb> server # [ 134.328962] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql vm-test-run-timescaledb> server # [ 134.619323] postgres[1592]: ::1 2026-10-26 08:11:50.073 UTC [1592] supabase_admin@postgres LOG: statement: drop event trigger if exists api_restart; vm-test-run-timescaledb> server # [ 134.631361] postgres[1592]: ::1 2026-10-26 08:11:50.081 UTC [1592] supabase_admin@postgres LOG: statement: drop function if exists extensions.notify_api_restart(); vm-test-run-timescaledb> server # [ 134.635111] postgres[1592]: ::1 2026-10-26 08:11:50.092 UTC [1592] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_ddl_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 134.643938] postgres[1592]: DECLARE vm-test-run-timescaledb> server # [ 134.649967] postgres[1592]: cmd record; vm-test-run-timescaledb> server # [ 134.651504] postgres[1592]: BEGIN vm-test-run-timescaledb> server # [ 134.654160] postgres[1592]: FOR cmd IN SELECT * FROM pg_event_trigger_ddl_commands() vm-test-run-timescaledb> server # [ 134.657614] postgres[1592]: LOOP vm-test-run-timescaledb> server # [ 134.659065] postgres[1592]: IF cmd.command_tag IN ( vm-test-run-timescaledb> server # [ 134.660598] postgres[1592]: 'CREATE SCHEMA', 'ALTER SCHEMA' vm-test-run-timescaledb> server # [ 134.661578] postgres[1592]: , 'CREATE TABLE', 'CREATE TABLE AS', 'SELECT INTO', 'ALTER TABLE' vm-test-run-timescaledb> server # [ 134.662508] postgres[1592]: , 'CREATE FOREIGN TABLE', 'ALTER FOREIGN TABLE' vm-test-run-timescaledb> server # [ 134.664190] postgres[1592]: , 'CREATE VIEW', 'ALTER VIEW' vm-test-run-timescaledb> server # [ 134.665593] postgres[1592]: , 'CREATE MATERIALIZED VIEW', 'ALTER MATERIALIZED VIEW' vm-test-run-timescaledb> server # [ 134.667451] postgres[1592]: , 'CREATE FUNCTION', 'ALTER FUNCTION' vm-test-run-timescaledb> server # [ 134.668037] postgres[1592]: , 'CREATE TRIGGER' vm-test-run-timescaledb> server # [ 134.669301] postgres[1592]: , 'CREATE TYPE' vm-test-run-timescaledb> server # [ 134.669915] postgres[1592]: , 'CREATE RULE' vm-test-run-timescaledb> server # [ 134.670921] postgres[1592]: , 'COMMENT' vm-test-run-timescaledb> server # [ 134.672058] postgres[1592]: ) vm-test-run-timescaledb> server # [ 134.673468] postgres[1592]: -- don't notify in case of CREATE TEMP table or other objects created on pg_temp vm-test-run-timescaledb> server # [ 134.674009] postgres[1592]: AND cmd.schema_name is distinct from 'pg_temp' vm-test-run-timescaledb> server # [ 134.674781] postgres[1592]: THEN vm-test-run-timescaledb> server # [ 134.675265] postgres[1592]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 134.676372] postgres[1592]: END IF; vm-test-run-timescaledb> server # [ 134.678610] postgres[1592]: END LOOP; vm-test-run-timescaledb> server # [ 134.681347] postgres[1592]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 134.687184] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:3: NOTICE: event trigger "api_restart" does not exist, skipping vm-test-run-timescaledb> server # [ 134.691962] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.693411] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:4: NOTICE: function extensions.notify_api_restart() does not exist, skipping vm-test-run-timescaledb> server # [ 134.699605] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: DROP FUNCTION vm-test-run-timescaledb> server # [ 134.703531] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 134.709893] postgres[1592]: ::1 2026-10-26 08:11:50.129 UTC [1592] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_drop_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 134.712047] postgres[1592]: DECLARE vm-test-run-timescaledb> server # [ 134.714254] postgres[1592]: obj record; vm-test-run-timescaledb> server # [ 134.721172] postgres[1592]: BEGIN vm-test-run-timescaledb> server # [ 134.721711] postgres[1592]: FOR obj IN SELECT * FROM pg_event_trigger_dropped_objects() vm-test-run-timescaledb> server # [ 134.723285] postgres[1592]: LOOP vm-test-run-timescaledb> server # [ 134.724277] postgres[1592]: IF obj.object_type IN ( vm-test-run-timescaledb> server # [ 134.727330] postgres[1592]: 'schema' vm-test-run-timescaledb> server # [ 134.729757] postgres[1592]: , 'table' vm-test-run-timescaledb> server # [ 134.731498] postgres[1592]: , 'foreign table' vm-test-run-timescaledb> server # [ 134.731952] postgres[1592]: , 'view' vm-test-run-timescaledb> server # [ 134.733466] postgres[1592]: , 'materialized view' vm-test-run-timescaledb> server # [ 134.735275] postgres[1592]: , 'function' vm-test-run-timescaledb> server # [ 134.736337] postgres[1592]: , 'trigger' vm-test-run-timescaledb> server # [ 134.740962] postgres[1592]: , 'type' vm-test-run-timescaledb> server # [ 134.741900] postgres[1592]: , 'rule' vm-test-run-timescaledb> server # [ 134.745912] postgres[1592]: ) vm-test-run-timescaledb> server # [ 134.747878] postgres[1592]: AND obj.is_temporary IS false -- no pg_temp objects vm-test-run-timescaledb> server # [ 134.749742] postgres[1592]: THEN vm-test-run-timescaledb> server # [ 134.751867] postgres[1592]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 134.754250] postgres[1592]: END IF; vm-test-run-timescaledb> server # [ 134.754765] postgres[1592]: END LOOP; vm-test-run-timescaledb> server # [ 134.755206] postgres[1592]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 134.755515] postgres[1592]: ::1 2026-10-26 08:11:50.156 UTC [1592] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_ddl_watch; vm-test-run-timescaledb> server # [ 134.759266] postgres[1592]: ::1 2026-10-26 08:11:50.166 UTC [1592] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_ddl_watch vm-test-run-timescaledb> server # [ 134.762046] postgres[1592]: ON ddl_command_end vm-test-run-timescaledb> server # [ 134.763343] postgres[1592]: EXECUTE PROCEDURE extensions.pgrst_ddl_watch(); vm-test-run-timescaledb> server # [ 134.765543] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 134.766104] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:59: NOTICE: event trigger "pgrst_ddl_watch" does not exist, skipping vm-test-run-timescaledb> server # [ 134.769598] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.770624] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.771144] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220126121436_finer-postgrest-triggers.sql:64: NOTICE: event trigger "pgrst_drop_watch" does not exist, skipping vm-test-run-timescaledb> server # [ 134.772018] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.774152] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1591]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 134.775675] postgres[1592]: ::1 2026-10-26 08:11:50.184 UTC [1592] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_drop_watch; vm-test-run-timescaledb> server # [ 134.778944] postgres[1592]: ::1 2026-10-26 08:11:50.195 UTC [1592] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_drop_watch vm-test-run-timescaledb> server # [ 134.781465] postgres[1592]: ON sql_drop vm-test-run-timescaledb> server # [ 134.782606] postgres[1592]: EXECUTE PROCEDURE extensions.pgrst_drop_watch(); vm-test-run-timescaledb> server # [ 134.831400] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220224211803_fix-postgrest-supautils.sql vm-test-run-timescaledb> server # [ 136.294577] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1593]: DO vm-test-run-timescaledb> server # [ 136.323133] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql vm-test-run-timescaledb> server # [ 136.572422] postgres[1620]: ::1 2026-10-26 08:11:52.026 UTC [1620] supabase_admin@postgres LOG: statement: create schema if not exists graphql_public; vm-test-run-timescaledb> server # [ 136.618735] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: CREATE SCHEMA vm-test-run-timescaledb> server # [ 136.620273] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql:5: NOTICE: function graphql_public.graphql(text,text,jsonb) does not exist, skipping vm-test-run-timescaledb> server # [ 136.629380] postgres[1620]: ::1 2026-10-26 08:11:52.078 UTC [1620] supabase_admin@postgres LOG: statement: drop function if exists graphql_public.graphql(text, text, jsonb); vm-test-run-timescaledb> server # [ 136.631244] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: DROP FUNCTION vm-test-run-timescaledb> server # [ 136.637087] postgres[1620]: ::1 2026-10-26 08:11:52.096 UTC [1620] supabase_admin@postgres LOG: statement: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 136.638121] postgres[1620]: "operationName" text default null, vm-test-run-timescaledb> server # [ 136.638765] postgres[1620]: query text default null, vm-test-run-timescaledb> server # [ 136.640337] postgres[1620]: variables jsonb default null, vm-test-run-timescaledb> server # [ 136.645930] postgres[1620]: extensions jsonb default null vm-test-run-timescaledb> server # [ 136.647165] postgres[1620]: ) vm-test-run-timescaledb> server # [ 136.647727] postgres[1620]: returns jsonb vm-test-run-timescaledb> server # [ 136.654658] postgres[1620]: language plpgsql vm-test-run-timescaledb> server # [ 136.655922] postgres[1620]: as $$ vm-test-run-timescaledb> server # [ 136.661603] postgres[1620]: DECLARE vm-test-run-timescaledb> server # [ 136.662704] postgres[1620]: server_version float; vm-test-run-timescaledb> server # [ 136.663455] postgres[1620]: BEGIN vm-test-run-timescaledb> server # [ 136.663816] postgres[1620]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 136.669565] postgres[1620]: vm-test-run-timescaledb> server # [ 136.670309] postgres[1620]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 136.670743] postgres[1620]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 136.671382] postgres[1620]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 136.671989] postgres[1620]: 'errors', array['pg_graphql extension is not enabled.'] vm-test-run-timescaledb> server # [ 136.675003] postgres[1620]: ); vm-test-run-timescaledb> server # [ 136.676078] postgres[1620]: ELSE vm-test-run-timescaledb> server # [ 136.682698] postgres[1620]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 136.683425] postgres[1620]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 136.685798] postgres[1620]: 'errors', array['pg_graphql is only available on projects running Postgres 14 onwards.'] vm-test-run-timescaledb> server # [ 136.686953] postgres[1620]: ); vm-test-run-timescaledb> server # [ 136.687745] postgres[1620]: END IF; vm-test-run-timescaledb> server # [ 136.692056] postgres[1620]: END; vm-test-run-timescaledb> server # [ 136.693598] postgres[1620]: $$; vm-test-run-timescaledb> server # [ 136.694151] postgres[1620]: ::1 2026-10-26 08:11:52.126 UTC [1620] supabase_admin@postgres LOG: statement: grant usage on schema graphql_public to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.694734] postgres[1620]: ::1 2026-10-26 08:11:52.151 UTC [1620] supabase_admin@postgres LOG: statement: alter default privileges in schema graphql_public grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.696141] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 136.697670] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: GRANT vm-test-run-timescaledb> server # [ 136.707989] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 136.714402] postgres[1620]: ::1 2026-10-26 08:11:52.175 UTC [1620] supabase_admin@postgres LOG: statement: alter default privileges in schema graphql_public grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.723426] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 136.726008] postgres[1620]: ::1 2026-10-26 08:11:52.190 UTC [1620] supabase_admin@postgres LOG: statement: alter default privileges in schema graphql_public grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.737566] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 136.741085] postgres[1620]: ::1 2026-10-26 08:11:52.205 UTC [1620] supabase_admin@postgres LOG: statement: alter default privileges for user supabase_admin in schema graphql_public grant all vm-test-run-timescaledb> server # [ 136.743157] postgres[1620]: on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.750969] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 136.751933] postgres[1620]: ::1 2026-10-26 08:11:52.216 UTC [1620] supabase_admin@postgres LOG: statement: alter default privileges for user supabase_admin in schema graphql_public grant all vm-test-run-timescaledb> server # [ 136.763160] postgres[1620]: on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.770864] postgres[1620]: ::1 2026-10-26 08:11:52.231 UTC [1620] supabase_admin@postgres LOG: statement: alter default privileges for user supabase_admin in schema graphql_public grant all vm-test-run-timescaledb> server # [ 136.772053] postgres[1620]: on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.777310] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 136.782415] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 136.789347] postgres[1620]: ::1 2026-10-26 08:11:52.251 UTC [1620] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 136.790475] postgres[1620]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 136.791950] postgres[1620]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 136.792941] postgres[1620]: AS $func$ vm-test-run-timescaledb> server # [ 136.793435] postgres[1620]: DECLARE vm-test-run-timescaledb> server # [ 136.796068] postgres[1620]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 136.797756] postgres[1620]: BEGIN vm-test-run-timescaledb> server # [ 136.798040] postgres[1620]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 136.798711] postgres[1620]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 136.799039] postgres[1620]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 136.799323] postgres[1620]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 136.802723] postgres[1620]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 136.803386] postgres[1620]: ); vm-test-run-timescaledb> server # [ 136.803666] postgres[1620]: vm-test-run-timescaledb> server # [ 136.804241] postgres[1620]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 136.804642] postgres[1620]: THEN vm-test-run-timescaledb> server # [ 136.805991] postgres[1620]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.806852] postgres[1620]: grant all on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.807453] postgres[1620]: vm-test-run-timescaledb> server # [ 136.808118] postgres[1620]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.809554] postgres[1620]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.809987] postgres[1620]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.810319] postgres[1620]: vm-test-run-timescaledb> server # [ 136.810562] postgres[1620]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 136.810838] postgres[1620]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 136.813588] postgres[1620]: "operationName" text default null, vm-test-run-timescaledb> server # [ 136.814235] postgres[1620]: query text default null, vm-test-run-timescaledb> server # [ 136.817184] postgres[1620]: variables jsonb default null, vm-test-run-timescaledb> server # [ 136.818092] postgres[1620]: extensions jsonb default null vm-test-run-timescaledb> server # [ 136.825396] postgres[1620]: ) vm-test-run-timescaledb> server # [ 136.826885] postgres[1620]: returns jsonb vm-test-run-timescaledb> server # [ 136.827839] postgres[1620]: language sql vm-test-run-timescaledb> server # [ 136.828334] postgres[1620]: as $$ vm-test-run-timescaledb> server # [ 136.829576] postgres[1620]: SELECT graphql.resolve(query, coalesce(variables, '{}')); vm-test-run-timescaledb> server # [ 136.830928] postgres[1620]: $$; vm-test-run-timescaledb> server # [ 136.831375] postgres[1620]: vm-test-run-timescaledb> server # [ 136.834360] postgres[1620]: grant execute on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 136.835023] postgres[1620]: END IF; vm-test-run-timescaledb> server # [ 136.835454] postgres[1620]: vm-test-run-timescaledb> server # [ 136.835707] postgres[1620]: END; vm-test-run-timescaledb> server # [ 136.837285] postgres[1620]: $func$; vm-test-run-timescaledb> server # [ 136.839287] postgres[1620]: ::1 2026-10-26 08:11:52.273 UTC [1620] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS issue_pg_graphql_access; vm-test-run-timescaledb> server # [ 136.839825] postgres[1620]: ::1 2026-10-26 08:11:52.285 UTC [1620] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER issue_pg_graphql_access ON ddl_command_end WHEN TAG in ('CREATE FUNCTION') vm-test-run-timescaledb> server # [ 136.841143] postgres[1620]: EXECUTE PROCEDURE extensions.grant_pg_graphql_access(); vm-test-run-timescaledb> server # [ 136.841900] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 136.842443] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql:90: NOTICE: event trigger "issue_pg_graphql_access" does not exist, skipping vm-test-run-timescaledb> server # [ 136.843225] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 136.843561] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 136.844985] postgres[1620]: ::1 2026-10-26 08:11:52.304 UTC [1620] supabase_admin@postgres LOG: statement: COMMENT ON FUNCTION extensions.grant_pg_graphql_access IS 'Grants access to pg_graphql'; vm-test-run-timescaledb> server # [ 136.855066] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: COMMENT vm-test-run-timescaledb> server # [ 136.860215] postgres[1620]: ::1 2026-10-26 08:11:52.322 UTC [1620] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.set_graphql_placeholder() vm-test-run-timescaledb> server # [ 136.865403] postgres[1620]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 136.866642] postgres[1620]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 136.867526] postgres[1620]: AS $func$ vm-test-run-timescaledb> server # [ 136.877666] postgres[1620]: DECLARE vm-test-run-timescaledb> server # [ 136.878591] postgres[1620]: graphql_is_dropped bool; vm-test-run-timescaledb> server # [ 136.879025] postgres[1620]: BEGIN vm-test-run-timescaledb> server # [ 136.879704] postgres[1620]: graphql_is_dropped = ( vm-test-run-timescaledb> server # [ 136.880039] postgres[1620]: SELECT ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 136.889418] postgres[1620]: FROM pg_event_trigger_dropped_objects() AS ev vm-test-run-timescaledb> server # [ 136.890775] postgres[1620]: WHERE ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 136.895446] postgres[1620]: ); vm-test-run-timescaledb> server # [ 136.903480] postgres[1620]: vm-test-run-timescaledb> server # [ 136.914694] postgres[1620]: IF graphql_is_dropped vm-test-run-timescaledb> server # [ 136.915400] postgres[1620]: THEN vm-test-run-timescaledb> server # [ 136.916091] postgres[1620]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 136.922828] postgres[1620]: "operationName" text default null, vm-test-run-timescaledb> server # [ 136.923771] postgres[1620]: query text default null, vm-test-run-timescaledb> server # [ 136.935482] postgres[1620]: variables jsonb default null, vm-test-run-timescaledb> server # [ 136.937135] postgres[1620]: extensions jsonb default null vm-test-run-timescaledb> server # [ 136.938181] postgres[1620]: ) vm-test-run-timescaledb> server # [ 136.938576] postgres[1620]: returns jsonb vm-test-run-timescaledb> server # [ 136.938834] postgres[1620]: language plpgsql vm-test-run-timescaledb> server # [ 136.944293] postgres[1620]: as $$ vm-test-run-timescaledb> server # [ 136.953618] postgres[1620]: DECLARE vm-test-run-timescaledb> server # [ 136.953988] postgres[1620]: server_version float; vm-test-run-timescaledb> server # [ 136.955062] postgres[1620]: BEGIN vm-test-run-timescaledb> server # [ 136.956010] postgres[1620]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 136.962277] postgres[1620]: vm-test-run-timescaledb> server # [ 136.964071] postgres[1620]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 136.966092] postgres[1620]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 136.982881] postgres[1620]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 136.986221] postgres[1620]: 'errors', array['pg_graphql extension is not enabled.'] vm-test-run-timescaledb> server # [ 136.987672] postgres[1620]: ); vm-test-run-timescaledb> server # [ 136.995350] postgres[1620]: ELSE vm-test-run-timescaledb> server # [ 137.001996] postgres[1620]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 137.002722] postgres[1620]: 'data', null::jsonb, vm-test-run-timescaledb> server # [ 137.003420] postgres[1620]: 'errors', array['pg_graphql is only available on projects running Postgres 14 onwards.'] vm-test-run-timescaledb> server # [ 137.008989] postgres[1620]: ); vm-test-run-timescaledb> server # [ 137.010495] postgres[1620]: END IF; vm-test-run-timescaledb> server # [ 137.019412] postgres[1620]: END; vm-test-run-timescaledb> server # [ 137.021906] postgres[1620]: $$; vm-test-run-timescaledb> server # [ 137.022492] postgres[1620]: END IF; vm-test-run-timescaledb> server # [ 137.033456] postgres[1620]: vm-test-run-timescaledb> server # [ 137.035094] postgres[1620]: END; vm-test-run-timescaledb> server # [ 137.055083] postgres[1620]: $func$; vm-test-run-timescaledb> server # [ 137.057515] postgres[1620]: ::1 2026-10-26 08:11:52.393 UTC [1620] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS issue_graphql_placeholder; vm-test-run-timescaledb> server # [ 137.058958] postgres[1620]: ::1 2026-10-26 08:11:52.406 UTC [1620] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER issue_graphql_placeholder ON sql_drop WHEN TAG in ('DROP EXTENSION') vm-test-run-timescaledb> server # [ 137.066575] postgres[1620]: EXECUTE PROCEDURE extensions.set_graphql_placeholder(); vm-test-run-timescaledb> server # [ 137.074891] postgres[1620]: ::1 2026-10-26 08:11:52.414 UTC [1620] supabase_admin@postgres LOG: statement: COMMENT ON FUNCTION extensions.set_graphql_placeholder IS 'Reintroduces placeholder function for graphql_public.graphql'; vm-test-run-timescaledb> server # [ 137.083610] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 137.095005] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220317095840_pg_graphql.sql:143: NOTICE: event trigger "issue_graphql_placeholder" does not exist, skipping vm-test-run-timescaledb> server # [ 137.099321] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 137.107615] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 137.114783] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1619]: COMMENT vm-test-run-timescaledb> server # [ 137.121291] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220321174452_fix-postgrest-alter-type-event-trigger.sql vm-test-run-timescaledb> server # [ 137.372166] postgres[1626]: ::1 2026-10-26 08:11:52.829 UTC [1626] supabase_admin@postgres LOG: statement: drop event trigger if exists api_restart; vm-test-run-timescaledb> server # [ 137.395985] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220321174452_fix-postgrest-alter-type-event-trigger.sql:3: NOTICE: event trigger "api_restart" does not exist, skipping vm-test-run-timescaledb> server # [ 137.403758] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 137.408006] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220321174452_fix-postgrest-alter-type-event-trigger.sql:4: NOTICE: function extensions.notify_api_restart() does not exist, skipping vm-test-run-timescaledb> server # [ 137.415017] postgres[1626]: ::1 2026-10-26 08:11:52.846 UTC [1626] supabase_admin@postgres LOG: statement: drop function if exists extensions.notify_api_restart(); vm-test-run-timescaledb> server # [ 137.424964] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: DROP FUNCTION vm-test-run-timescaledb> server # [ 137.432508] postgres[1626]: ::1 2026-10-26 08:11:52.892 UTC [1626] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_ddl_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 137.434817] postgres[1626]: DECLARE vm-test-run-timescaledb> server # [ 137.446430] postgres[1626]: cmd record; vm-test-run-timescaledb> server # [ 137.447631] postgres[1626]: BEGIN vm-test-run-timescaledb> server # [ 137.460344] postgres[1626]: FOR cmd IN SELECT * FROM pg_event_trigger_ddl_commands() vm-test-run-timescaledb> server # [ 137.467110] postgres[1626]: LOOP vm-test-run-timescaledb> server # [ 137.467826] postgres[1626]: IF cmd.command_tag IN ( vm-test-run-timescaledb> server # [ 137.473574] postgres[1626]: 'CREATE SCHEMA', 'ALTER SCHEMA' vm-test-run-timescaledb> server # [ 137.479463] postgres[1626]: , 'CREATE TABLE', 'CREATE TABLE AS', 'SELECT INTO', 'ALTER TABLE' vm-test-run-timescaledb> server # [ 137.486366] postgres[1626]: , 'CREATE FOREIGN TABLE', 'ALTER FOREIGN TABLE' vm-test-run-timescaledb> server # [ 137.494465] postgres[1626]: , 'CREATE VIEW', 'ALTER VIEW' vm-test-run-timescaledb> server # [ 137.495389] postgres[1626]: , 'CREATE MATERIALIZED VIEW', 'ALTER MATERIALIZED VIEW' vm-test-run-timescaledb> server # [ 137.500176] postgres[1626]: , 'CREATE FUNCTION', 'ALTER FUNCTION' vm-test-run-timescaledb> server # [ 137.512937] postgres[1626]: , 'CREATE TRIGGER' vm-test-run-timescaledb> server # [ 137.514077] postgres[1626]: , 'CREATE TYPE', 'ALTER TYPE' vm-test-run-timescaledb> server # [ 137.514763] postgres[1626]: , 'CREATE RULE' vm-test-run-timescaledb> server # [ 137.515218] postgres[1626]: , 'COMMENT' vm-test-run-timescaledb> server # [ 137.515700] postgres[1626]: ) vm-test-run-timescaledb> server # [ 137.523772] postgres[1626]: -- don't notify in case of CREATE TEMP table or other objects created on pg_temp vm-test-run-timescaledb> server # [ 137.526531] postgres[1626]: AND cmd.schema_name is distinct from 'pg_temp' vm-test-run-timescaledb> server # [ 137.527039] postgres[1626]: THEN vm-test-run-timescaledb> server # [ 137.527354] postgres[1626]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 137.527634] postgres[1626]: END IF; vm-test-run-timescaledb> server # [ 137.535805] postgres[1626]: END LOOP; vm-test-run-timescaledb> server # [ 137.539622] postgres[1626]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 137.546202] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 137.550964] postgres[1626]: ::1 2026-10-26 08:11:53.012 UTC [1626] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.pgrst_drop_watch() RETURNS event_trigger AS $$ vm-test-run-timescaledb> server # [ 137.551850] postgres[1626]: DECLARE vm-test-run-timescaledb> server # [ 137.564522] postgres[1626]: obj record; vm-test-run-timescaledb> server # [ 137.566979] postgres[1626]: BEGIN vm-test-run-timescaledb> server # [ 137.569418] postgres[1626]: FOR obj IN SELECT * FROM pg_event_trigger_dropped_objects() vm-test-run-timescaledb> server # [ 137.570064] postgres[1626]: LOOP vm-test-run-timescaledb> server # [ 137.571112] postgres[1626]: IF obj.object_type IN ( vm-test-run-timescaledb> server # [ 137.574136] postgres[1626]: 'schema' vm-test-run-timescaledb> server # [ 137.574882] postgres[1626]: , 'table' vm-test-run-timescaledb> server # [ 137.575222] postgres[1626]: , 'foreign table' vm-test-run-timescaledb> server # [ 137.575487] postgres[1626]: , 'view' vm-test-run-timescaledb> server # [ 137.576019] postgres[1626]: , 'materialized view' vm-test-run-timescaledb> server # [ 137.577883] postgres[1626]: , 'function' vm-test-run-timescaledb> server # [ 137.578377] postgres[1626]: , 'trigger' vm-test-run-timescaledb> server # [ 137.578904] postgres[1626]: , 'type' vm-test-run-timescaledb> server # [ 137.579699] postgres[1626]: , 'rule' vm-test-run-timescaledb> server # [ 137.580190] postgres[1626]: ) vm-test-run-timescaledb> server # [ 137.581833] postgres[1626]: AND obj.is_temporary IS false -- no pg_temp objects vm-test-run-timescaledb> server # [ 137.582690] postgres[1626]: THEN vm-test-run-timescaledb> server # [ 137.583853] postgres[1626]: NOTIFY pgrst, 'reload schema'; vm-test-run-timescaledb> server # [ 137.587676] postgres[1626]: END IF; vm-test-run-timescaledb> server # [ 137.588348] postgres[1626]: END LOOP; vm-test-run-timescaledb> server # [ 137.589549] postgres[1626]: END; $$ LANGUAGE plpgsql; vm-test-run-timescaledb> server # [ 137.605825] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 137.613602] postgres[1626]: ::1 2026-10-26 08:11:53.074 UTC [1626] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_ddl_watch; vm-test-run-timescaledb> server # [ 137.629578] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 137.630562] postgres[1626]: ::1 2026-10-26 08:11:53.092 UTC [1626] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_ddl_watch vm-test-run-timescaledb> server # [ 137.631867] postgres[1626]: ON ddl_command_end vm-test-run-timescaledb> server # [ 137.632279] postgres[1626]: EXECUTE PROCEDURE extensions.pgrst_ddl_watch(); vm-test-run-timescaledb> server # [ 137.653555] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 137.654495] postgres[1626]: ::1 2026-10-26 08:11:53.114 UTC [1626] supabase_admin@postgres LOG: statement: DROP EVENT TRIGGER IF EXISTS pgrst_drop_watch; vm-test-run-timescaledb> server # [ 137.663667] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 137.670771] postgres[1626]: ::1 2026-10-26 08:11:53.131 UTC [1626] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER pgrst_drop_watch vm-test-run-timescaledb> server # [ 137.672061] postgres[1626]: ON sql_drop vm-test-run-timescaledb> server # [ 137.675091] postgres[1626]: EXECUTE PROCEDURE extensions.pgrst_drop_watch(); vm-test-run-timescaledb> server # [ 137.689819] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1624]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 137.731949] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220322085208_gotrue-session-limit.sql vm-test-run-timescaledb> server # [ 138.038194] postgres[1628]: ::1 2026-10-26 08:11:53.490 UTC [1628] supabase_admin@postgres LOG: statement: ALTER ROLE supabase_auth_admin SET idle_in_transaction_session_timeout TO 60000; vm-test-run-timescaledb> server # [ 138.046184] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1627]: ALTER ROLE vm-test-run-timescaledb> server # [ 138.094910] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220404205710_pg_graphql-on-by-default.sql vm-test-run-timescaledb> server # [ 138.549217] postgres[1633]: ::1 2026-10-26 08:11:53.976 UTC [1633] supabase_admin@postgres LOG: statement: create or replace function extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 138.559458] postgres[1633]: returns event_trigger vm-test-run-timescaledb> server # [ 138.566145] postgres[1633]: language plpgsql vm-test-run-timescaledb> server # [ 138.573812] postgres[1633]: AS $func$ vm-test-run-timescaledb> server # [ 138.575325] postgres[1633]: DECLARE vm-test-run-timescaledb> server # [ 138.585433] postgres[1633]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 138.587112] postgres[1633]: BEGIN vm-test-run-timescaledb> server # [ 138.588542] postgres[1633]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 138.589949] postgres[1633]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 138.591633] postgres[1633]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 138.597416] postgres[1633]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 138.599198] postgres[1633]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 138.605862] postgres[1633]: ); vm-test-run-timescaledb> server # [ 138.607155] postgres[1633]: vm-test-run-timescaledb> server # [ 138.615011] postgres[1633]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 138.618515] postgres[1633]: THEN vm-test-run-timescaledb> server # [ 138.625302] postgres[1633]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.627951] postgres[1633]: grant all on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.633364] postgres[1633]: vm-test-run-timescaledb> server # [ 138.633845] postgres[1633]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.634219] postgres[1633]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.634567] postgres[1633]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.635873] postgres[1633]: vm-test-run-timescaledb> server # [ 138.646247] postgres[1633]: -- Update public wrapper to pass all arguments through to the pg_graphql resolve func vm-test-run-timescaledb> server # [ 138.653195] postgres[1633]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 138.655508] postgres[1633]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 138.662398] postgres[1633]: "operationName" text default null, vm-test-run-timescaledb> server # [ 138.663644] postgres[1633]: query text default null, vm-test-run-timescaledb> server # [ 138.664099] postgres[1633]: variables jsonb default null, vm-test-run-timescaledb> server # [ 138.669724] postgres[1633]: extensions jsonb default null vm-test-run-timescaledb> server # [ 138.671284] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.683623] postgres[1633]: returns jsonb vm-test-run-timescaledb> server # [ 138.689857] postgres[1633]: language sql vm-test-run-timescaledb> server # [ 138.692075] postgres[1633]: as $$ vm-test-run-timescaledb> server # [ 138.698722] postgres[1633]: -- This changed vm-test-run-timescaledb> server # [ 138.706148] postgres[1633]: select graphql.resolve( vm-test-run-timescaledb> server # [ 138.707648] postgres[1633]: query := query, vm-test-run-timescaledb> server # [ 138.709611] postgres[1633]: variables := coalesce(variables, '{}'), vm-test-run-timescaledb> server # [ 138.712387] postgres[1633]: "operationName" := "operationName", vm-test-run-timescaledb> server # [ 138.725140] postgres[1633]: extensions := extensions vm-test-run-timescaledb> server # [ 138.727224] postgres[1633]: ); vm-test-run-timescaledb> server # [ 138.728975] postgres[1633]: $$; vm-test-run-timescaledb> server # [ 138.730209] postgres[1633]: vm-test-run-timescaledb> server # [ 138.731590] postgres[1633]: grant execute on function graphql.resolve to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 138.733980] postgres[1633]: END IF; vm-test-run-timescaledb> server # [ 138.735646] postgres[1633]: vm-test-run-timescaledb> server # [ 138.736242] postgres[1633]: END; vm-test-run-timescaledb> server # [ 138.737280] postgres[1633]: $func$; vm-test-run-timescaledb> server # [ 138.751011] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1629]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 138.753453] postgres[1633]: ::1 2026-10-26 08:11:54.214 UTC [1633] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.set_graphql_placeholder() vm-test-run-timescaledb> server # [ 138.754607] postgres[1633]: RETURNS event_trigger vm-test-run-timescaledb> server # [ 138.754955] postgres[1633]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 138.755237] postgres[1633]: AS $func$ vm-test-run-timescaledb> server # [ 138.756008] postgres[1633]: DECLARE vm-test-run-timescaledb> server # [ 138.756425] postgres[1633]: graphql_is_dropped bool; vm-test-run-timescaledb> server # [ 138.768317] postgres[1633]: BEGIN vm-test-run-timescaledb> server # [ 138.769616] postgres[1633]: graphql_is_dropped = ( vm-test-run-timescaledb> server # [ 138.770336] postgres[1633]: SELECT ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 138.770959] postgres[1633]: FROM pg_event_trigger_dropped_objects() AS ev vm-test-run-timescaledb> server # [ 138.771262] postgres[1633]: WHERE ev.schema_name = 'graphql_public' vm-test-run-timescaledb> server # [ 138.771669] postgres[1633]: ); vm-test-run-timescaledb> server # [ 138.773038] postgres[1633]: vm-test-run-timescaledb> server # [ 138.773360] postgres[1633]: IF graphql_is_dropped vm-test-run-timescaledb> server # [ 138.774351] postgres[1633]: THEN vm-test-run-timescaledb> server # [ 138.774909] postgres[1633]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 138.775571] postgres[1633]: "operationName" text default null, vm-test-run-timescaledb> server # [ 138.775905] postgres[1633]: query text default null, vm-test-run-timescaledb> server # [ 138.779099] postgres[1633]: variables jsonb default null, vm-test-run-timescaledb> server # [ 138.786376] postgres[1633]: extensions jsonb default null vm-test-run-timescaledb> server # [ 138.787042] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.787356] postgres[1633]: returns jsonb vm-test-run-timescaledb> server # [ 138.787629] postgres[1633]: language plpgsql vm-test-run-timescaledb> server # [ 138.787906] postgres[1633]: as $$ vm-test-run-timescaledb> server # [ 138.788136] postgres[1633]: DECLARE vm-test-run-timescaledb> server # [ 138.788362] postgres[1633]: server_version float; vm-test-run-timescaledb> server # [ 138.788600] postgres[1633]: BEGIN vm-test-run-timescaledb> server # [ 138.789008] postgres[1633]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 138.790254] postgres[1633]: vm-test-run-timescaledb> server # [ 138.790951] postgres[1633]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 138.791646] postgres[1633]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 138.791942] postgres[1633]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 138.792219] postgres[1633]: jsonb_build_object( vm-test-run-timescaledb> server # [ 138.797560] postgres[1633]: 'message', 'pg_graphql extension is not enabled.' vm-test-run-timescaledb> server # [ 138.798504] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.799482] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.806533] postgres[1633]: ); vm-test-run-timescaledb> server # [ 138.807937] postgres[1633]: ELSE vm-test-run-timescaledb> server # [ 138.814262] postgres[1633]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 138.815145] postgres[1633]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 138.815553] postgres[1633]: jsonb_build_object( vm-test-run-timescaledb> server # [ 138.816207] postgres[1633]: 'message', 'pg_graphql is only available on projects running Postgres 14 onwards.' vm-test-run-timescaledb> server # [ 138.821121] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.821720] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.822011] postgres[1633]: ); vm-test-run-timescaledb> server # [ 138.824162] postgres[1633]: END IF; vm-test-run-timescaledb> server # [ 138.830536] postgres[1633]: END; vm-test-run-timescaledb> server # [ 138.831550] postgres[1633]: $$; vm-test-run-timescaledb> server # [ 138.833505] postgres[1633]: END IF; vm-test-run-timescaledb> server # [ 138.834293] postgres[1633]: vm-test-run-timescaledb> server # [ 138.835878] postgres[1633]: END; vm-test-run-timescaledb> server # [ 138.841524] postgres[1633]: $func$; vm-test-run-timescaledb> server # [ 138.843386] postgres[1633]: ::1 2026-10-26 08:11:54.251 UTC [1633] supabase_admin@postgres LOG: statement: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 138.844468] postgres[1633]: "operationName" text default null, vm-test-run-timescaledb> server # [ 138.849683] postgres[1633]: query text default null, vm-test-run-timescaledb> server # [ 138.851189] postgres[1633]: variables jsonb default null, vm-test-run-timescaledb> server # [ 138.863686] postgres[1633]: extensions jsonb default null vm-test-run-timescaledb> server # [ 138.868886] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.872304] postgres[1633]: returns jsonb vm-test-run-timescaledb> server # [ 138.889242] postgres[1633]: language plpgsql vm-test-run-timescaledb> server # [ 138.892033] postgres[1633]: as $$ vm-test-run-timescaledb> server # [ 138.898630] postgres[1633]: DECLARE vm-test-run-timescaledb> server # [ 138.913091] postgres[1633]: server_version float; vm-test-run-timescaledb> server # [ 138.921713] postgres[1633]: BEGIN vm-test-run-timescaledb> server # [ 138.923986] postgres[1633]: server_version = (SELECT (SPLIT_PART((select version()), ' ', 2))::float); vm-test-run-timescaledb> server # [ 138.935626] postgres[1633]: vm-test-run-timescaledb> server # [ 138.941597] postgres[1633]: IF server_version >= 14 THEN vm-test-run-timescaledb> server # [ 138.946183] postgres[1633]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 138.962148] postgres[1633]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 138.964172] postgres[1633]: jsonb_build_object( vm-test-run-timescaledb> server # [ 138.967302] postgres[1633]: 'message', 'pg_graphql extension is not enabled.' vm-test-run-timescaledb> server # [ 138.975999] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.985584] postgres[1633]: ) vm-test-run-timescaledb> server # [ 138.987607] postgres[1633]: ); vm-test-run-timescaledb> server # [ 139.005373] postgres[1633]: ELSE vm-test-run-timescaledb> server # [ 139.006175] postgres[1633]: RETURN jsonb_build_object( vm-test-run-timescaledb> server # [ 139.006525] postgres[1633]: 'errors', jsonb_build_array( vm-test-run-timescaledb> server # [ 139.006796] postgres[1633]: jsonb_build_object( vm-test-run-timescaledb> server # [ 139.015680] postgres[1633]: 'message', 'pg_graphql is only available on projects running Postgres 14 onwards.' vm-test-run-timescaledb> server # [ 139.018108] postgres[1633]: ) vm-test-run-timescaledb> server # [ 139.018799] postgres[1633]: ) vm-test-run-timescaledb> server # [ 139.019779] postgres[1633]: ); vm-test-run-timescaledb> server # [ 139.025336] postgres[1633]: END IF; vm-test-run-timescaledb> server # [ 139.025941] postgres[1633]: END; vm-test-run-timescaledb> server # [ 139.028140] postgres[1633]: $$; vm-test-run-timescaledb> server # [ 139.039597] postgres[1633]: ::1 2026-10-26 08:11:54.274 UTC [1633] supabase_admin@postgres LOG: statement: drop extension if exists pg_graphql; vm-test-run-timescaledb> server # [ 139.046946] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1629]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 139.055373] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1629]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 139.057764] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1629]: psql:/nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220404205710_pg_graphql-on-by-default.sql:142: NOTICE: extension "pg_graphql" does not exist, skipping vm-test-run-timescaledb> server # [ 139.059152] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1629]: DROP EXTENSION vm-test-run-timescaledb> server # [ 140.723545] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1629]: DO vm-test-run-timescaledb> server # [ 140.778158] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220609081115_grant-supabase-auth-admin-and-supabase-storage-admin-to-postgres.sql vm-test-run-timescaledb> server # [ 141.027374] postgres[1656]: ::1 2026-10-26 08:11:56.487 UTC [1656] supabase_admin@postgres LOG: statement: grant supabase_auth_admin, supabase_storage_admin to postgres; vm-test-run-timescaledb> server # [ 141.045910] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1655]: GRANT ROLE vm-test-run-timescaledb> server # [ 141.079688] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220613123923_pg_graphql-pg-dump-perms.sql vm-test-run-timescaledb> server # [ 141.620115] postgres[1665]: ::1 2026-10-26 08:11:57.074 UTC [1665] supabase_admin@postgres LOG: statement: create or replace function extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 141.641596] postgres[1665]: returns event_trigger vm-test-run-timescaledb> server # [ 141.642369] postgres[1665]: language plpgsql vm-test-run-timescaledb> server # [ 141.642787] postgres[1665]: AS $func$ vm-test-run-timescaledb> server # [ 141.643087] postgres[1665]: DECLARE vm-test-run-timescaledb> server # [ 141.643476] postgres[1665]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 141.653108] postgres[1665]: BEGIN vm-test-run-timescaledb> server # [ 141.664463] postgres[1665]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 141.667904] postgres[1665]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 141.668323] postgres[1665]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 141.681596] postgres[1665]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 141.684468] postgres[1665]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 141.695442] postgres[1665]: ); vm-test-run-timescaledb> server # [ 141.701597] postgres[1665]: vm-test-run-timescaledb> server # [ 141.702697] postgres[1665]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 141.703992] postgres[1665]: THEN vm-test-run-timescaledb> server # [ 141.709619] postgres[1665]: -- Update public wrapper to pass all arguments through to the pg_graphql resolve func vm-test-run-timescaledb> server # [ 141.717815] postgres[1665]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 141.727496] postgres[1665]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 141.735284] postgres[1665]: "operationName" text default null, vm-test-run-timescaledb> server # [ 141.742044] postgres[1665]: query text default null, vm-test-run-timescaledb> server # [ 141.743169] postgres[1665]: variables jsonb default null, vm-test-run-timescaledb> server # [ 141.753083] postgres[1665]: extensions jsonb default null vm-test-run-timescaledb> server # [ 141.755690] postgres[1665]: ) vm-test-run-timescaledb> server # [ 141.769676] postgres[1665]: returns jsonb vm-test-run-timescaledb> server # [ 141.771608] postgres[1665]: language sql vm-test-run-timescaledb> server # [ 141.772872] postgres[1665]: as $$ vm-test-run-timescaledb> server # [ 141.773473] postgres[1665]: select graphql.resolve( vm-test-run-timescaledb> server # [ 141.773778] postgres[1665]: query := query, vm-test-run-timescaledb> server # [ 141.774053] postgres[1665]: variables := coalesce(variables, '{}'), vm-test-run-timescaledb> server # [ 141.775281] postgres[1665]: "operationName" := "operationName", vm-test-run-timescaledb> server # [ 141.782737] postgres[1665]: extensions := extensions vm-test-run-timescaledb> server # [ 141.798781] postgres[1665]: ); vm-test-run-timescaledb> server # [ 141.809598] postgres[1665]: $$; vm-test-run-timescaledb> server # [ 141.811878] postgres[1665]: vm-test-run-timescaledb> server # [ 141.822867] postgres[1665]: -- This hook executes when `graphql.resolve` is created. That is not necessarily the last vm-test-run-timescaledb> server # [ 141.829394] postgres[1665]: -- function in the extension so we need to grant permissions on existing entities AND vm-test-run-timescaledb> server # [ 141.831493] postgres[1665]: -- update default permissions to any others that are created after `graphql.resolve` vm-test-run-timescaledb> server # [ 141.841260] postgres[1665]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 141.842217] postgres[1665]: grant select on all tables in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 141.842823] postgres[1665]: grant execute on all functions in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 141.851179] postgres[1665]: grant all on all sequences in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 141.857861] postgres[1665]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 141.861643] postgres[1665]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 141.865551] postgres[1665]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 141.867370] postgres[1665]: END IF; vm-test-run-timescaledb> server # [ 141.868033] postgres[1665]: vm-test-run-timescaledb> server # [ 141.873648] postgres[1665]: END; vm-test-run-timescaledb> server # [ 141.874480] postgres[1665]: $func$; vm-test-run-timescaledb> server # [ 141.899004] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1657]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 141.905508] postgres[1665]: ::1 2026-10-26 08:11:57.327 UTC [1665] supabase_admin@postgres LOG: statement: drop extension if exists pg_graphql; vm-test-run-timescaledb> server # [ 141.958466] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1657]: DROP EXTENSION vm-test-run-timescaledb> server # [ 143.736636] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1657]: DO vm-test-run-timescaledb> server # [ 143.795134] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20220713082019_pg_cron-pg_net-temp-perms-fix.sql vm-test-run-timescaledb> server # [ 144.904069] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1687]: DO vm-test-run-timescaledb> server # [ 145.703873] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1687]: DO vm-test-run-timescaledb> server # [ 145.783711] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20221028101028_set_authenticator_timeout.sql vm-test-run-timescaledb> server # [ 146.182679] postgres[1714]: ::1 2026-10-26 08:12:01.641 UTC [1714] supabase_admin@postgres LOG: statement: alter role authenticator set statement_timeout = '8s'; vm-test-run-timescaledb> server # [ 146.209114] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1711]: ALTER ROLE vm-test-run-timescaledb> server # [ 146.239828] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20221103090837_revoke_admin.sql vm-test-run-timescaledb> server # [ 146.501745] postgres[1716]: ::1 2026-10-26 08:12:01.958 UTC [1716] supabase_admin@postgres LOG: statement: revoke supabase_admin from authenticator; vm-test-run-timescaledb> server # [ 146.519668] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1715]: REVOKE ROLE vm-test-run-timescaledb> server # [ 146.551922] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20221207154255_create_pgsodium_and_vault.sql vm-test-run-timescaledb> server # [ 149.051653] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1717]: DO vm-test-run-timescaledb> server # [ 149.099040] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230201083204_grant_auth_roles_to_postgres.sql vm-test-run-timescaledb> server # [ 149.419432] postgres[1748]: ::1 2026-10-26 08:12:04.875 UTC [1748] supabase_admin@postgres LOG: statement: grant anon, authenticated, service_role to postgres; vm-test-run-timescaledb> server # [ 149.432049] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1743]: GRANT ROLE vm-test-run-timescaledb> server # [ 149.474048] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230224042246_grant_extensions_perms_for_postgres.sql vm-test-run-timescaledb> server # [ 149.807317] postgres[1750]: ::1 2026-10-26 08:12:05.265 UTC [1750] supabase_admin@postgres LOG: statement: grant all privileges on all tables in schema extensions to postgres with grant option; vm-test-run-timescaledb> server # [ 149.854795] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1749]: GRANT vm-test-run-timescaledb> server # [ 149.865156] postgres[1750]: ::1 2026-10-26 08:12:05.317 UTC [1750] supabase_admin@postgres LOG: statement: grant all privileges on all routines in schema extensions to postgres with grant option; vm-test-run-timescaledb> server # [ 149.905134] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1749]: GRANT vm-test-run-timescaledb> server # [ 149.907245] postgres[1750]: ::1 2026-10-26 08:12:05.370 UTC [1750] supabase_admin@postgres LOG: statement: grant all privileges on all sequences in schema extensions to postgres with grant option; vm-test-run-timescaledb> server # [ 149.914509] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1749]: GRANT vm-test-run-timescaledb> server # [ 149.915856] postgres[1750]: ::1 2026-10-26 08:12:05.378 UTC [1750] supabase_admin@postgres LOG: statement: alter default privileges in schema extensions grant all on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 149.927165] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1749]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 149.934623] postgres[1750]: ::1 2026-10-26 08:12:05.393 UTC [1750] supabase_admin@postgres LOG: statement: alter default privileges in schema extensions grant all on routines to postgres with grant option; vm-test-run-timescaledb> server # [ 149.941169] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1749]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 149.944911] postgres[1750]: ::1 2026-10-26 08:12:05.407 UTC [1750] supabase_admin@postgres LOG: statement: alter default privileges in schema extensions grant all on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 149.950987] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1749]: ALTER DEFAULT PRIVILEGES vm-test-run-timescaledb> server # [ 149.996960] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230306081037_grant_pg_monitor_to_postgres.sql vm-test-run-timescaledb> server # [ 150.232108] postgres[1752]: ::1 2026-10-26 08:12:05.692 UTC [1752] supabase_admin@postgres LOG: statement: grant pg_monitor to postgres; vm-test-run-timescaledb> server # [ 150.248641] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1751]: GRANT ROLE vm-test-run-timescaledb> server # [ 150.295748] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230327032006_grant_auth_roles_to_supabase_storage_admin.sql vm-test-run-timescaledb> server # [ 150.543612] postgres[1754]: ::1 2026-10-26 08:12:06.000 UTC [1754] supabase_admin@postgres LOG: statement: grant anon, authenticated, service_role to supabase_storage_admin; vm-test-run-timescaledb> server # [ 150.570273] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1753]: GRANT ROLE vm-test-run-timescaledb> server # [ 150.606183] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20230529180330_alter_api_roles_for_inherit.sql vm-test-run-timescaledb> server # [ 150.940019] postgres[1759]: ::1 2026-10-26 08:12:06.393 UTC [1759] supabase_admin@postgres LOG: statement: ALTER ROLE authenticated inherit; vm-test-run-timescaledb> server # [ 150.979206] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1755]: ALTER ROLE vm-test-run-timescaledb> server # [ 150.989777] postgres[1759]: ::1 2026-10-26 08:12:06.430 UTC [1759] supabase_admin@postgres LOG: statement: ALTER ROLE anon inherit; vm-test-run-timescaledb> server # [ 150.996274] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1755]: ALTER ROLE vm-test-run-timescaledb> server # [ 150.998708] postgres[1759]: ::1 2026-10-26 08:12:06.462 UTC [1759] supabase_admin@postgres LOG: statement: ALTER ROLE service_role inherit; vm-test-run-timescaledb> server # [ 151.013342] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1755]: ALTER ROLE vm-test-run-timescaledb> server # [ 151.067692] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1755]: DO vm-test-run-timescaledb> server # [ 151.137600] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231013070755_grant_authenticator_to_supabase_storage_admin.sql vm-test-run-timescaledb> server # [ 151.654297] postgres[1771]: ::1 2026-10-26 08:12:07.099 UTC [1771] supabase_admin@postgres LOG: statement: grant authenticator to supabase_storage_admin; vm-test-run-timescaledb> server # [ 151.695626] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1766]: GRANT ROLE vm-test-run-timescaledb> server # [ 151.706709] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1766]: REVOKE ROLE vm-test-run-timescaledb> server # [ 151.715032] postgres[1771]: ::1 2026-10-26 08:12:07.134 UTC [1771] supabase_admin@postgres LOG: statement: revoke anon, authenticated, service_role from supabase_storage_admin; vm-test-run-timescaledb> server # [ 151.751989] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231017062225_grant_pg_graphql_permissions_for_custom_roles.sql vm-test-run-timescaledb> server # [ 152.219921] postgres[1778]: ::1 2026-10-26 08:12:07.668 UTC [1778] supabase_admin@postgres LOG: statement: create or replace function extensions.grant_pg_graphql_access() vm-test-run-timescaledb> server # [ 152.226071] postgres[1778]: returns event_trigger vm-test-run-timescaledb> server # [ 152.227064] postgres[1778]: language plpgsql vm-test-run-timescaledb> server # [ 152.227492] postgres[1778]: AS $func$ vm-test-run-timescaledb> server # [ 152.227788] postgres[1778]: DECLARE vm-test-run-timescaledb> server # [ 152.228049] postgres[1778]: func_is_graphql_resolve bool; vm-test-run-timescaledb> server # [ 152.233920] postgres[1778]: BEGIN vm-test-run-timescaledb> server # [ 152.234679] postgres[1778]: func_is_graphql_resolve = ( vm-test-run-timescaledb> server # [ 152.235056] postgres[1778]: SELECT n.proname = 'resolve' vm-test-run-timescaledb> server # [ 152.235710] postgres[1778]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 152.237069] postgres[1778]: LEFT JOIN pg_catalog.pg_proc AS n vm-test-run-timescaledb> server # [ 152.242478] postgres[1778]: ON ev.objid = n.oid vm-test-run-timescaledb> server # [ 152.243269] postgres[1778]: ); vm-test-run-timescaledb> server # [ 152.244140] postgres[1778]: vm-test-run-timescaledb> server # [ 152.253446] postgres[1778]: IF func_is_graphql_resolve vm-test-run-timescaledb> server # [ 152.254077] postgres[1778]: THEN vm-test-run-timescaledb> server # [ 152.254793] postgres[1778]: -- Update public wrapper to pass all arguments through to the pg_graphql resolve func vm-test-run-timescaledb> server # [ 152.256301] postgres[1778]: DROP FUNCTION IF EXISTS graphql_public.graphql; vm-test-run-timescaledb> server # [ 152.257895] postgres[1778]: create or replace function graphql_public.graphql( vm-test-run-timescaledb> server # [ 152.258402] postgres[1778]: "operationName" text default null, vm-test-run-timescaledb> server # [ 152.258909] postgres[1778]: query text default null, vm-test-run-timescaledb> server # [ 152.259237] postgres[1778]: variables jsonb default null, vm-test-run-timescaledb> server # [ 152.259573] postgres[1778]: extensions jsonb default null vm-test-run-timescaledb> server # [ 152.259916] postgres[1778]: ) vm-test-run-timescaledb> server # [ 152.266589] postgres[1778]: returns jsonb vm-test-run-timescaledb> server # [ 152.273388] postgres[1778]: language sql vm-test-run-timescaledb> server # [ 152.274609] postgres[1778]: as $$ vm-test-run-timescaledb> server # [ 152.275176] postgres[1778]: select graphql.resolve( vm-test-run-timescaledb> server # [ 152.275496] postgres[1778]: query := query, vm-test-run-timescaledb> server # [ 152.276227] postgres[1778]: variables := coalesce(variables, '{}'), vm-test-run-timescaledb> server # [ 152.281062] postgres[1778]: "operationName" := "operationName", vm-test-run-timescaledb> server # [ 152.282795] postgres[1778]: extensions := extensions vm-test-run-timescaledb> server # [ 152.283203] postgres[1778]: ); vm-test-run-timescaledb> server # [ 152.283466] postgres[1778]: $$; vm-test-run-timescaledb> server # [ 152.283728] postgres[1778]: vm-test-run-timescaledb> server # [ 152.283956] postgres[1778]: -- This hook executes when `graphql.resolve` is created. That is not necessarily the last vm-test-run-timescaledb> server # [ 152.289796] postgres[1778]: -- function in the extension so we need to grant permissions on existing entities AND vm-test-run-timescaledb> server # [ 152.291240] postgres[1778]: -- update default permissions to any others that are created after `graphql.resolve` vm-test-run-timescaledb> server # [ 152.291840] postgres[1778]: grant usage on schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 152.292315] postgres[1778]: grant select on all tables in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 152.305162] postgres[1778]: grant execute on all functions in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 152.307721] postgres[1778]: grant all on all sequences in schema graphql to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 152.313467] postgres[1778]: alter default privileges in schema graphql grant all on tables to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 152.314821] postgres[1778]: alter default privileges in schema graphql grant all on functions to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 152.315599] postgres[1778]: alter default privileges in schema graphql grant all on sequences to postgres, anon, authenticated, service_role; vm-test-run-timescaledb> server # [ 152.322275] postgres[1778]: vm-test-run-timescaledb> server # [ 152.322973] postgres[1778]: -- Allow postgres role to allow granting usage on graphql and graphql_public schemas to custom roles vm-test-run-timescaledb> server # [ 152.330460] postgres[1778]: grant usage on schema graphql_public to postgres with grant option; vm-test-run-timescaledb> server # [ 152.331431] postgres[1778]: grant usage on schema graphql to postgres with grant option; vm-test-run-timescaledb> server # [ 152.337582] postgres[1778]: END IF; vm-test-run-timescaledb> server # [ 152.338739] postgres[1778]: vm-test-run-timescaledb> server # [ 152.340124] postgres[1778]: END; vm-test-run-timescaledb> server # [ 152.345565] postgres[1778]: $func$; vm-test-run-timescaledb> server # [ 152.346309] postgres[1778]: ::1 2026-10-26 08:12:07.795 UTC [1778] supabase_admin@postgres LOG: statement: drop extension if exists pg_graphql; vm-test-run-timescaledb> server # [ 152.350719] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1775]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 152.467796] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1775]: DROP EXTENSION vm-test-run-timescaledb> server # [ 154.168540] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1775]: DO vm-test-run-timescaledb> server # [ 154.212044] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231020085357_revoke_writes_on_cron_job_from_postgres.sql vm-test-run-timescaledb> server # [ 154.713751] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1789]: DO vm-test-run-timescaledb> server # [ 154.743312] postgres[1793]: ::1 2026-10-26 08:12:10.158 UTC [1793] supabase_admin@postgres LOG: statement: CREATE OR REPLACE FUNCTION extensions.grant_pg_cron_access() RETURNS event_trigger vm-test-run-timescaledb> server # [ 154.752833] postgres[1793]: LANGUAGE plpgsql vm-test-run-timescaledb> server # [ 154.754993] postgres[1793]: AS $$ vm-test-run-timescaledb> server # [ 154.755608] postgres[1793]: BEGIN vm-test-run-timescaledb> server # [ 154.756004] postgres[1793]: IF EXISTS ( vm-test-run-timescaledb> server # [ 154.761805] postgres[1793]: SELECT vm-test-run-timescaledb> server # [ 154.763108] postgres[1793]: FROM pg_event_trigger_ddl_commands() AS ev vm-test-run-timescaledb> server # [ 154.770639] postgres[1793]: JOIN pg_extension AS ext vm-test-run-timescaledb> server # [ 154.772180] postgres[1793]: ON ev.objid = ext.oid vm-test-run-timescaledb> server # [ 154.777856] postgres[1793]: WHERE ext.extname = 'pg_cron' vm-test-run-timescaledb> server # [ 154.779815] postgres[1793]: ) vm-test-run-timescaledb> server # [ 154.789734] postgres[1793]: THEN vm-test-run-timescaledb> server # [ 154.797351] postgres[1793]: grant usage on schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 154.807239] postgres[1793]: vm-test-run-timescaledb> server # [ 154.809805] postgres[1793]: alter default privileges in schema cron grant all on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 154.810793] postgres[1793]: alter default privileges in schema cron grant all on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 154.811684] postgres[1793]: alter default privileges in schema cron grant all on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 154.812084] postgres[1793]: vm-test-run-timescaledb> server # [ 154.812934] postgres[1793]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 154.832592] postgres[1793]: on sequences to postgres with grant option; vm-test-run-timescaledb> server # [ 154.833771] postgres[1793]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 154.835779] postgres[1793]: on tables to postgres with grant option; vm-test-run-timescaledb> server # [ 154.838717] postgres[1793]: alter default privileges for user supabase_admin in schema cron grant all vm-test-run-timescaledb> server # [ 154.839313] postgres[1793]: on functions to postgres with grant option; vm-test-run-timescaledb> server # [ 154.840453] postgres[1793]: vm-test-run-timescaledb> server # [ 154.853624] postgres[1793]: grant all privileges on all tables in schema cron to postgres with grant option; vm-test-run-timescaledb> server # [ 154.861641] postgres[1793]: revoke all on table cron.job from postgres; vm-test-run-timescaledb> server # [ 154.863447] postgres[1793]: grant select on table cron.job to postgres with grant option; vm-test-run-timescaledb> server # [ 154.869668] postgres[1793]: END IF; vm-test-run-timescaledb> server # [ 154.870323] postgres[1793]: END; vm-test-run-timescaledb> server # [ 154.870611] postgres[1793]: $$; vm-test-run-timescaledb> server # [ 154.890769] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1789]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 154.891847] postgres[1793]: ::1 2026-10-26 08:12:10.355 UTC [1793] supabase_admin@postgres LOG: statement: drop event trigger if exists issue_pg_cron_access; vm-test-run-timescaledb> server # [ 154.905087] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1789]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 154.906469] postgres[1793]: ::1 2026-10-26 08:12:10.370 UTC [1793] supabase_admin@postgres LOG: statement: alter function extensions.grant_pg_cron_access owner to supabase_admin; vm-test-run-timescaledb> server # [ 154.917306] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1789]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 154.918368] postgres[1793]: ::1 2026-10-26 08:12:10.382 UTC [1793] supabase_admin@postgres LOG: statement: CREATE EVENT TRIGGER issue_pg_cron_access ON ddl_command_end vm-test-run-timescaledb> server # [ 154.919343] postgres[1793]: WHEN TAG IN ('CREATE EXTENSION') vm-test-run-timescaledb> server # [ 154.920039] postgres[1793]: EXECUTE FUNCTION extensions.grant_pg_cron_access(); vm-test-run-timescaledb> server # [ 154.933145] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1789]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 154.981533] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20231130133139_set_lock_timeout_to_authenticator_role.sql vm-test-run-timescaledb> server # [ 155.458911] postgres[1814]: ::1 2026-10-26 08:12:10.907 UTC [1814] supabase_admin@postgres LOG: statement: ALTER ROLE authenticator set lock_timeout to '8s'; vm-test-run-timescaledb> server # [ 155.487083] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1806]: ALTER ROLE vm-test-run-timescaledb> server # [ 155.534032] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20240124080435_alter_lo_export_lo_import_owner.sql vm-test-run-timescaledb> server # [ 155.955907] postgres[1818]: ::1 2026-10-26 08:12:11.404 UTC [1818] supabase_admin@postgres LOG: statement: alter function pg_catalog.lo_export owner to supabase_admin; vm-test-run-timescaledb> server # [ 156.031670] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1817]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 156.041647] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1817]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 156.042208] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1817]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 156.043416] postgres[1818]: ::1 2026-10-26 08:12:11.490 UTC [1818] supabase_admin@postgres LOG: statement: alter function pg_catalog.lo_import(text) owner to supabase_admin; vm-test-run-timescaledb> server # [ 156.045849] postgres[1818]: ::1 2026-10-26 08:12:11.498 UTC [1818] supabase_admin@postgres LOG: statement: alter function pg_catalog.lo_import(text, oid) owner to supabase_admin; vm-test-run-timescaledb> server # [ 156.081356] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20240606060239_grant_predefined_roles_to_postgres.sql vm-test-run-timescaledb> server # [ 156.381717] postgres[1820]: ::1 2026-10-26 08:12:11.838 UTC [1820] supabase_admin@postgres LOG: statement: grant pg_read_all_data, pg_signal_backend to postgres; vm-test-run-timescaledb> server # [ 156.406444] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1819]: GRANT ROLE vm-test-run-timescaledb> server # [ 156.446832] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20241031003909_create_orioledb.sql vm-test-run-timescaledb> server # [ 157.510372] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1821]: DO vm-test-run-timescaledb> server # [ 157.588079] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20241215003910_backfill_pgmq_metadata.sql vm-test-run-timescaledb> server # [ 158.256618] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1828]: DO vm-test-run-timescaledb> server # [ 158.263908] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1828]: DO vm-test-run-timescaledb> server # [ 158.313706] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250205060043_disable_log_statement_on_internal_roles.sql vm-test-run-timescaledb> server # [ 158.893203] postgres[1846]: ::1 2026-10-26 08:12:14.304 UTC [1846] supabase_admin@postgres LOG: statement: alter role supabase_admin set log_statement = none; vm-test-run-timescaledb> server # [ 158.913251] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1840]: ALTER ROLE vm-test-run-timescaledb> server # [ 158.915755] postgres[1846]: ::1 2026-10-26 08:12:14.370 UTC [1846] supabase_admin@postgres LOG: statement: alter role supabase_auth_admin set log_statement = none; vm-test-run-timescaledb> server # [ 158.921084] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1840]: ALTER ROLE vm-test-run-timescaledb> server # [ 158.923122] postgres[1846]: ::1 2026-10-26 08:12:14.386 UTC [1846] supabase_admin@postgres LOG: statement: alter role supabase_storage_admin set log_statement = none; vm-test-run-timescaledb> server # [ 158.937620] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1840]: ALTER ROLE vm-test-run-timescaledb> server # [ 159.005486] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250205144616_move_orioledb_to_extensions_schema.sql vm-test-run-timescaledb> server # [ 159.561520] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1851]: DO vm-test-run-timescaledb> server # [ 159.592044] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250218031949_pgsodium_mask_role.sql vm-test-run-timescaledb> server # [ 159.956391] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1857]: DO vm-test-run-timescaledb> server # [ 160.002786] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250220051611_pg_net_perms_fix.sql vm-test-run-timescaledb> server # [ 160.308009] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1859]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 160.318534] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1859]: DO vm-test-run-timescaledb> server # [ 160.373550] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250312095419_pgbouncer_ownership.sql vm-test-run-timescaledb> server # [ 160.730441] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1861]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 160.734553] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1861]: GRANT vm-test-run-timescaledb> server # [ 160.785967] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250402065937_alter_internal_event_triggers_owner_to_supabase_admin.sql vm-test-run-timescaledb> server # [ 161.395110] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1865]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 161.443012] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1865]: ALTER FUNCTION vm-test-run-timescaledb> server # [ 161.461084] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1865]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 161.543803] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250402093753_grant_subscription_to_postgres_16_and_above.sql vm-test-run-timescaledb> server # [ 162.188664] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1879]: DO vm-test-run-timescaledb> server # [ 162.223417] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250417190610_update_pgbouncer_get_auth.sql vm-test-run-timescaledb> server # [ 162.651910] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1889]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 162.661989] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1889]: GRANT vm-test-run-timescaledb> server # [ 162.699162] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250421084701_revoke_admin_roles_from_postgres.sql vm-test-run-timescaledb> server # [ 162.954520] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1893]: REVOKE ROLE vm-test-run-timescaledb> server # [ 162.982050] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1893]: DO vm-test-run-timescaledb> server # [ 162.996258] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1893]: DO vm-test-run-timescaledb> server # [ 163.003711] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1893]: REVOKE ROLE vm-test-run-timescaledb> server # [ 163.015402] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1893]: REVOKE vm-test-run-timescaledb> server # [ 163.042694] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1893]: DO vm-test-run-timescaledb> server # [ 163.089363] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250605172253_grant_with_admin_to_postgres_16_and_above.sql vm-test-run-timescaledb> server # [ 163.523181] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1895]: DO vm-test-run-timescaledb> server # [ 163.570740] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250623125453_tmp_grant_storage_tables_to_postgres_with_grant_option.sql vm-test-run-timescaledb> server # [ 163.989391] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1901]: DO vm-test-run-timescaledb> server # [ 164.042272] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250709135250_grant_storage_schema_to_postgres_with_grant_option.sql vm-test-run-timescaledb> server # [ 164.564687] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1903]: DO vm-test-run-timescaledb> server # [ 164.598293] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20250710151649_supabase_read_only_user_default_transaction_read_only.sql vm-test-run-timescaledb> server # [ 165.098087] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1916]: ALTER ROLE vm-test-run-timescaledb> server # [ 165.115440] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20251001204436_predefined_role_grants.sql vm-test-run-timescaledb> server # [ 165.588792] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1928]: GRANT ROLE vm-test-run-timescaledb> server # [ 165.633399] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1928]: DO vm-test-run-timescaledb> server # [ 165.681393] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20251105172723_grant_pg_reload_conf_to_postgres.sql vm-test-run-timescaledb> server # [ 166.111380] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1933]: GRANT vm-test-run-timescaledb> server # [ 166.129659] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20251121132723_correct_search_path_pgbouncer.sql vm-test-run-timescaledb> server # [ 166.413890] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1935]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 166.418414] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1935]: REVOKE vm-test-run-timescaledb> server # [ 166.430250] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1935]: REVOKE vm-test-run-timescaledb> server # [ 166.443111] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1935]: GRANT vm-test-run-timescaledb> server # [ 166.482582] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260211120934_supabase_privileged_role.sql vm-test-run-timescaledb> server # [ 166.773704] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1937]: DO vm-test-run-timescaledb> server # [ 166.811360] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260413000000_fix-authenticator-session-preload-libraries.sql vm-test-run-timescaledb> server # [ 167.235704] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1939]: ALTER ROLE vm-test-run-timescaledb> server # [ 167.267376] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260421000000_pg_graphql-off-by-default.sql vm-test-run-timescaledb> server # [ 167.911385] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1945]: DROP EXTENSION vm-test-run-timescaledb> server # [ 167.915416] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260421000001_rescope_pg_graphql_access_trigger.sql vm-test-run-timescaledb> server # [ 168.437987] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1957]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 168.447263] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1957]: DROP EVENT TRIGGER vm-test-run-timescaledb> server # [ 168.497428] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1957]: CREATE EVENT TRIGGER vm-test-run-timescaledb> server # [ 168.574539] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260730000000_revoke_trigger_on_cron_tables_from_postgres.sql vm-test-run-timescaledb> server # [ 168.891014] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1969]: DO vm-test-run-timescaledb> server # [ 168.916766] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1969]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 168.962100] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20260923021047_update_pgrst_watch_triggers.sql vm-test-run-timescaledb> server # [ 169.427828] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1971]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.445687] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1971]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.474379] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running migration: /nix/store/js0m5hf160s54dcv5rwafq9rrcgmr3bn-migrations-db/migrations/20261016000001_search_path_for_supa_functions.sql vm-test-run-timescaledb> server # [ 169.849885] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1977]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.866645] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1977]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.882650] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1977]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.903455] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1977]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.915038] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1977]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.930291] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1977]: CREATE FUNCTION vm-test-run-timescaledb> server # [ 169.986030] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Running postgresql schema... vm-test-run-timescaledb> server # [ 170.271088] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER DATABASE vm-test-run-timescaledb> server # [ 170.275478] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER DATABASE vm-test-run-timescaledb> server # [ 170.330560] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 170.383832] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 170.449421] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 170.554700] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 170.669903] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 170.783957] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 170.893180] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 171.007135] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 171.289871] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 171.290791] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1979]: ALTER ROLE vm-test-run-timescaledb> server # [ 171.353848] vajsrmb87v5n6q7zw49mmp7q0dxq2gln-supabase-db-init[1422]: Database initialization complete vm-test-run-timescaledb> server # [ 171.415524] systemd[1]: Finished Supabase Database Initialization. vm-test-run-timescaledb> server # [ 171.426153] systemd[1]: Reached target Multi-User System. vm-test-run-timescaledb> server # [ 171.453445] systemd[1]: Startup finished in 20.842s (kernel) + 2min 30.565s (userspace) = 2min 51.408s. vm-test-run-timescaledb> server: (finished: waiting for unit supabase-db-init.service, in 172.96 seconds) vm-test-run-timescaledb> subtest: Check upgrade path with postgresql 15 vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" vm-test-run-timescaledb> server # NOTICE: extension "timescaledb" does not exist, skipping vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" , in 0.51 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.9.1' CASCADE;" vm-test-run-timescaledb> server # [ 178.813374] postgres[2013]: [local] 2026-10-26 08:12:34.269 UTC [2013] supabase_admin@postgres WARNING: vm-test-run-timescaledb> server # WARNING: vm-test-run-timescaledb> server # WELCOME TO vm-test-run-timescaledb> server # _____ _ _ ____________ vm-test-run-timescaledb> server # |_ _(_) | | | _ \ ___ \ vm-test-run-timescaledb> server # | | _ _ __ ___ ___ ___ ___ __ _| | ___| | | | |_/ / vm-test-run-timescaledb> server # | | | | _ ` _ \ / _ \/ __|/ __/ _` | |/ _ \ | | | ___ \ vm-test-run-timescaledb> server # | | | | | | | | | __/\__ \ (_| (_| | | __/ |/ /| |_/ / vm-test-run-timescaledb> server # |_| |_|_| |_| |_|\___||___/\___\__,_|_|\___|___/ \____/ vm-test-run-timescaledb> server # Running version 2.9.1 vm-test-run-timescaledb> server # For more information on TimescaleDB, please visit the following links: vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # 1. Getting started: https://docs.timescale.com/timescaledb/latest/getting-started vm-test-run-timescaledb> server # 2. API reference documentation: https://docs.timescale.com/api/latest vm-test-run-timescaledb> server # 3. How TimescaleDB is designed: https://docs.timescale.com/timescaledb/latest/overview/core-concepts vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # Note: Please enable telemetry to help us improve our product by running: ALTER DATABASE "postgres" SET timescaledb.telemetry_level = 'basic'; vm-test-run-timescaledb> server # vm-test-run-timescaledb> server # [ 178.822697] postgres[2013]: WELCOME TO vm-test-run-timescaledb> server # [ 178.823550] postgres[2013]: _____ _ _ ____________ vm-test-run-timescaledb> server # [ 178.825609] postgres[2013]: |_ _(_) | | | _ \ ___ \ vm-test-run-timescaledb> server # [ 178.826847] postgres[2013]: | | _ _ __ ___ ___ ___ ___ __ _| | ___| | | | |_/ / vm-test-run-timescaledb> server # [ 178.828213] postgres[2013]: | | | | _ ` _ \ / _ \/ __|/ __/ _` | |/ _ \ | | | ___ \ vm-test-run-timescaledb> server # [ 178.832051] postgres[2013]: | | | | | | | | | __/\__ \ (_| (_| | | __/ |/ /| |_/ / vm-test-run-timescaledb> server # [ 178.837973] postgres[2013]: |_| |_|_| |_| |_|\___||___/\___\__,_|_|\___|___/ \____/ vm-test-run-timescaledb> server # [ 178.839645] postgres[2013]: Running version 2.9.1 vm-test-run-timescaledb> server # [ 178.846990] postgres[2013]: For more information on TimescaleDB, please visit the following links: vm-test-run-timescaledb> server # [ 178.848052] postgres[2013]: vm-test-run-timescaledb> server # [ 178.849780] postgres[2013]: 1. Getting started: https://docs.timescale.com/timescaledb/latest/getting-started vm-test-run-timescaledb> server # [ 178.851669] postgres[2013]: 2. API reference documentation: https://docs.timescale.com/api/latest vm-test-run-timescaledb> server # [ 178.865159] postgres[2013]: 3. How TimescaleDB is designed: https://docs.timescale.com/timescaledb/latest/overview/core-concepts vm-test-run-timescaledb> server # [ 178.868517] postgres[2013]: vm-test-run-timescaledb> server # [ 178.870834] postgres[2013]: Note: Please enable telemetry to help us improve our product by running: ALTER DATABASE "postgres" SET timescaledb.telemetry_level = 'basic'; vm-test-run-timescaledb> server # [ 178.875093] postgres[2013]: vm-test-run-timescaledb> server # [ 178.881050] postgres[2013]: [local] 2026-10-26 08:12:34.269 UTC [2013] supabase_admin@postgres CONTEXT: PL/pgSQL function inline_code_block line 16 at RAISE vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.9.1' CASCADE;" , in 6.62 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" vm-test-run-timescaledb> server # [ 179.641321] postgres[2065]: 2026-10-26 08:12:35.068 UTC [2065] LOG: job 2 threw an error vm-test-run-timescaledb> server # [ 179.651719] postgres[2065]: 2026-10-26 08:12:35.095 UTC [2065] ERROR: functionality not supported under the current "apache" license vm-test-run-timescaledb> server # [ 179.660501] postgres[2065]: 2026-10-26 08:12:35.095 UTC [2065] HINT: Upgrade your license to 'timescale' to use this free community feature. vm-test-run-timescaledb> server # [ 179.739765] postgres[1376]: 2026-10-26 08:12:35.195 UTC [1376] LOG: background worker "Error Log Retention Policy [2]" (PID 2065) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" , in 1.06 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "ALTER EXTENSION timescaledb UPDATE TO '2.16.1';" vm-test-run-timescaledb> server # [ 181.074818] postgres[2055]: 2026-10-26 08:12:36.518 UTC [2055] FATAL: terminating background worker "TimescaleDB Background Worker Scheduler" due to administrator command vm-test-run-timescaledb> server # [ 181.087619] postgres[1376]: 2026-10-26 08:12:36.549 UTC [1376] LOG: background worker "TimescaleDB Background Worker Scheduler" (PID 2055) exited with exit code 1 vm-test-run-timescaledb> server # [ 186.063899] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:08.0/virtio7/input/input3 vm-test-run-timescaledb> server # [ 188.694941] postgres[2085]: 2026-10-26 08:12:44.145 UTC [2085] FATAL: terminating background worker "TimescaleDB Background Worker Scheduler" due to administrator command vm-test-run-timescaledb> server # [ 188.728985] postgres[1376]: 2026-10-26 08:12:44.190 UTC [1376] LOG: background worker "TimescaleDB Background Worker Scheduler" (PID 2085) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "ALTER EXTENSION timescaledb UPDATE TO '2.16.1';" , in 9.24 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" vm-test-run-timescaledb> server # [ 189.735502] postgres[2152]: 2026-10-26 08:12:45.195 UTC [2152] LOG: job 3 threw an error vm-test-run-timescaledb> server # [ 189.750381] postgres[2152]: 2026-10-26 08:12:45.210 UTC [2152] ERROR: functionality not supported under the current "apache" license. Learn more at https://timescale.com/. vm-test-run-timescaledb> server # [ 189.761528] postgres[2152]: 2026-10-26 08:12:45.210 UTC [2152] HINT: To access all features and the best time-series experience, try out Timescale Cloud. vm-test-run-timescaledb> server # [ 189.808175] postgres[1376]: 2026-10-26 08:12:45.267 UTC [1376] LOG: background worker "Job History Log Retention Policy [3]" (PID 2152) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" , in 0.73 seconds) vm-test-run-timescaledb> (finished: subtest: Check upgrade path with postgresql 15, in 18.16 seconds) vm-test-run-timescaledb> subtest: Check the install of the last version of the extension vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" vm-test-run-timescaledb> server # [ 190.650146] postgres[2139]: 2026-10-26 08:12:46.103 UTC [2139] FATAL: terminating background worker "TimescaleDB Background Worker Scheduler" due to administrator command vm-test-run-timescaledb> server # [ 190.725597] postgres[1376]: 2026-10-26 08:12:46.186 UTC [1376] LOG: background worker "TimescaleDB Background Worker Scheduler" (PID 2139) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "DROP EXTENSION IF EXISTS timescaledb;" , in 1.53 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.16.1' CASCADE;" vm-test-run-timescaledb> server # [ 195.609820] systemd[1]: Starting Virtual Console Setup... vm-test-run-timescaledb> server # [ 195.956057] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. vm-test-run-timescaledb> server # [ 195.965181] systemd[1]: Stopped Virtual Console Setup. vm-test-run-timescaledb> server # [ 195.979968] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch. vm-test-run-timescaledb> server # [ 196.025242] systemd[1]: Starting Virtual Console Setup... vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "CREATE EXTENSION timescaledb WITH VERSION '2.16.1' CASCADE;" , in 7.56 seconds) vm-test-run-timescaledb> server: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" vm-test-run-timescaledb> server # [ 199.716136] systemd-logind[647]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard) vm-test-run-timescaledb> server # [ 200.009972] postgres[2219]: 2026-10-26 08:12:55.448 UTC [2219] LOG: job 3 threw an error vm-test-run-timescaledb> server # [ 200.022615] postgres[2219]: 2026-10-26 08:12:55.463 UTC [2219] ERROR: functionality not supported under the current "apache" license. Learn more at https://timescale.com/. vm-test-run-timescaledb> server # [ 200.024031] postgres[2219]: 2026-10-26 08:12:55.463 UTC [2219] HINT: To access all features and the best time-series experience, try out Timescale Cloud. vm-test-run-timescaledb> server # [ 200.087646] postgres[1376]: 2026-10-26 08:12:55.547 UTC [1376] LOG: background worker "Job History Log Retention Policy [3]" (PID 2219) exited with exit code 1 vm-test-run-timescaledb> server: (finished: must succeed: psql -U supabase_admin -d postgres -t -A -F"," -c "SELECT extversion FROM pg_extension WHERE extname = 'timescaledb';" , in 1.14 seconds) vm-test-run-timescaledb> (finished: subtest: Check the install of the last version of the extension, in 10.23 seconds) vm-test-run-timescaledb> (finished: run the VM test script, in 201.51 seconds) vm-test-run-timescaledb> test script finished in 202.24s vm-test-run-timescaledb> cleanup vm-test-run-timescaledb> kill machine (pid 9) vm-test-run-timescaledb> qemu-system-aarch64: terminating on signal 15 from pid 6 (/nix/store/y88crn50yx35fiiwcjx6xqwi6ahk7mlq-python3-3.13.11/bin/python3.13) vm-test-run-timescaledb> vde_switch: EOF data port: Interrupted system call vm-test-run-timescaledb> kill vlan (pid 7) vm-test-run-timescaledb> (finished: cleanup, in 0.01 seconds) vm-test-run-timescaledb> vde_switch: Caught signal 15, cleaning up and exiting