[58.749040] Initializing watchdogs
[58.749093]   /dev/watchdog0
[58.766237] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:7d55 Intel Meteorlake (Gen12) Meteor Lake-P [Intel Arc Graphics]
[58.770931] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.773538] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.777048] [001/133] (960s left) kms_psr (psr-cursor-render)
[58.893623] Starting subtest: psr-cursor-render
[58.895889] Starting dynamic subtest: eDP-1
[60.595841] Dynamic subtest eDP-1: SUCCESS (1.711s)
[60.598158] Subtest psr-cursor-render: SUCCESS (1.711s)
[61.446212] [002/133] (957s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[61.551065] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s)
[61.668600] [003/133] (957s left) kms_chamelium_audio (hdmi-audio)
[62.053043] Subtest hdmi-audio: SKIP (0.000s)
[62.850781] [004/133] (956s left) gem_lmem_swapping (basic)
[62.904681] Subtest basic: SKIP (0.000s)
[62.943450] [005/133] (956s left) kms_sequence (get-busy)
[63.038803] Starting subtest: get-busy
[63.040727] Starting dynamic subtest: pipe-A-eDP-1
[64.978389] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.947s)
[64.987654] Starting dynamic subtest: pipe-B-eDP-1
[67.570986] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.596s)
[67.579710] Starting dynamic subtest: pipe-C-eDP-1
[70.168621] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.603s)
[70.176494] Starting dynamic subtest: pipe-D-eDP-1
[72.697302] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.531s)
[72.699590] Subtest get-busy: SUCCESS (9.681s)
[73.489362] [006/133] (945s left) gem_mmap_offset (mmap-unmap)
[73.542817] Starting subtest: mmap-unmap
[73.544759] Starting dynamic subtest: smem0
[96.785717] Dynamic subtest smem0: SUCCESS (23.239s)
[96.788581] Subtest mmap-unmap: SUCCESS (23.239s)
[96.907636] [007/133] (922s left) gem_mmap (basic)
[96.965634] Subtest basic: SKIP (0.000s)
[97.036497] [008/133] (922s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc)
[97.133527] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc
[97.135741] Starting dynamic subtest: pipe-A-eDP-1
[97.157294] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[97.164659] Starting dynamic subtest: pipe-B-eDP-1
[97.185573] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[97.192742] Starting dynamic subtest: pipe-C-eDP-1
[97.213781] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[97.220297] Starting dynamic subtest: pipe-D-eDP-1
[97.241257] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[97.245151] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.003s)
[99.372607] [009/133] (920s left) gem_ctx_bad_destroy (invalid-ctx)
[99.429388] Starting subtest: invalid-ctx
[99.431662] Subtest invalid-ctx: SUCCESS (0.000s)
[99.498923] [010/133] (920s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-render)
[99.590177] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-render
[106.461274] Subtest psr-1p-offscreen-pri-shrfb-draw-render: SUCCESS (6.872s)
[106.608200] [011/133] (913s left) kms_flip (basic-flip-vs-modeset)
[106.695298] Starting subtest: basic-flip-vs-modeset
[106.697696] Starting dynamic subtest: A-eDP1
[109.285391] Dynamic subtest A-eDP1: SUCCESS (2.587s)
[109.295089] Starting dynamic subtest: B-eDP1
[111.453077] Dynamic subtest B-eDP1: SUCCESS (2.168s)
[111.460931] Starting dynamic subtest: C-eDP1
[113.530573] Dynamic subtest C-eDP1: SUCCESS (2.075s)
[113.539409] Starting dynamic subtest: D-eDP1
[115.682131] Dynamic subtest D-eDP1: SUCCESS (2.153s)
[115.684582] Subtest basic-flip-vs-modeset: SUCCESS (8.989s)
[116.487260] [012/133] (903s left) kms_vblank (wait-forked)
[116.593019] Starting subtest: wait-forked
[116.595319] Starting dynamic subtest: pipe-A-eDP-1
[118.403448] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.809s)
[118.418665] Starting dynamic subtest: pipe-D-eDP-1
[120.894333] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.487s)
[120.896735] Subtest wait-forked: SUCCESS (4.300s)
[121.753871] [013/133] (897s left) kms_big_fb (yf-tiled-addfb-size-offset-overflow)
[121.860303] Starting subtest: yf-tiled-addfb-size-offset-overflow
[121.864699] Subtest yf-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[121.954968] [014/133] (897s left) syncobj_wait (wait-all-complex)
[122.012873] Starting subtest: wait-all-complex
[122.228758] Subtest wait-all-complex: SUCCESS (0.215s)
[122.311639] [015/133] (897s left) gem_wait (busy)
[122.370643] Starting subtest: busy
[122.373062] Starting dynamic subtest: all-engines
[123.926688] Dynamic subtest all-engines: SUCCESS (1.554s)
[123.937084] Starting dynamic subtest: rcs0
[124.471769] Dynamic subtest rcs0: SUCCESS (0.543s)
[124.481388] Starting dynamic subtest: bcs0
[125.010411] Dynamic subtest bcs0: SUCCESS (0.539s)
[125.019982] Starting dynamic subtest: vcs0
[126.932490] Dynamic subtest vcs0: SUCCESS (1.920s)
[126.942699] Starting dynamic subtest: vcs1
[128.917247] Dynamic subtest vcs1: SUCCESS (1.983s)
[128.927748] Starting dynamic subtest: vecs0
[130.902456] Dynamic subtest vecs0: SUCCESS (1.982s)
[130.912653] Starting dynamic subtest: ccs0
[131.442501] Dynamic subtest ccs0: SUCCESS (0.541s)
[131.445477] Subtest busy: SUCCESS (9.071s)
[131.639017] [016/133] (888s left) syncobj_timeline (transfer-timeline-point)
[131.704405] Starting subtest: transfer-timeline-point
[131.706910] Subtest transfer-timeline-point: SUCCESS (0.001s)
[131.820710] [017/133] (888s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite)
[131.922384] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite
[138.881062] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (6.961s)
[139.004094] [018/133] (880s left) kms_content_protection (uevent)
[139.142102] Starting subtest: uevent
[139.146750] Subtest uevent: SKIP (0.000s)
[139.255949] [019/133] (880s left) kms_big_fb (4-tiled-32bpp-rotate-180)
[139.355066] Starting subtest: 4-tiled-32bpp-rotate-180
[140.743800] Subtest 4-tiled-32bpp-rotate-180: SUCCESS (1.390s)
[140.865394] [020/133] (879s left) kms_cursor_legacy (cursor-vs-flip-atomic)
[140.985290] Starting subtest: cursor-vs-flip-atomic
[170.343666] Subtest cursor-vs-flip-atomic: SUCCESS (29.358s)
[171.206760] [021/133] (848s left) gem_userptr_blits (create-destroy-sync)
[171.290514] Starting subtest: create-destroy-sync
[176.304993] Subtest create-destroy-sync: SUCCESS (5.016s)
[176.436147] [022/133] (843s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs-cc)
[176.534846] Starting subtest: crc-primary-suspend-4-tiled-dg2-rc-ccs-cc
[176.537144] Starting dynamic subtest: pipe-A-eDP-1
[176.546229] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[176.555295] Starting dynamic subtest: pipe-B-eDP-1
[176.564272] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[176.571826] Starting dynamic subtest: pipe-C-eDP-1
[176.580296] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[176.587746] Starting dynamic subtest: pipe-D-eDP-1
[176.596179] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[176.600228] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s)
[178.779329] [023/133] (841s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-submitted-signa
[178.853972] Starting subtest: multi-wait-for-submit-available-unsubmitted-submitted-signaled
[178.856437] Subtest multi-wait-for-submit-available-unsubmitted-submitted-signaled: SUCCESS (0.001s)
[178.950227] [024/133] (841s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu)
[179.043096] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu
[185.637231] Subtest fbcpsr-1p-primscrn-cur-indfb-draw-mmap-cpu: SUCCESS (6.597s)
[185.774465] [025/133] (834s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions)
[185.894956] Starting subtest: flip-vs-cursor-atomic-transitions
[193.559323] Subtest flip-vs-cursor-atomic-transitions: SUCCESS (7.661s)
[194.418959] [026/133] (825s left) prime_mmap (test_aperture_limit)
[194.475766] Starting subtest: test_aperture_limit
[194.477940] Starting dynamic subtest: test_aperture_limit-smem
[194.484757] Dynamic subtest test_aperture_limit-smem: SKIP (0.008s)
[194.488899] Subtest test_aperture_limit: SKIP (0.008s)
[194.578930] [027/133] (825s left) gem_ctx_param (set-priority-range)
[194.624764] Starting subtest: set-priority-range
[194.639627] Subtest set-priority-range: SUCCESS (0.015s)
[194.745521] [028/133] (825s left) perf_pmu (multi-client)
[194.782293] Starting subtest: multi-client
[194.784797] Starting dynamic subtest: rcs0
[195.838149] Dynamic subtest rcs0: SUCCESS (1.057s)
[195.848178] Starting dynamic subtest: bcs0
[196.887743] Dynamic subtest bcs0: SUCCESS (1.047s)
[196.896065] Starting dynamic subtest: vcs0
[197.938737] Dynamic subtest vcs0: SUCCESS (1.050s)
[197.948709] Starting dynamic subtest: vcs1
[199.948312] Dynamic subtest vcs1: SUCCESS (2.008s)
[199.958547] Starting dynamic subtest: vecs0
[201.935184] Dynamic subtest vecs0: SUCCESS (1.985s)
[201.949576] Starting dynamic subtest: ccs0
[203.916411] Dynamic subtest ccs0: SUCCESS (1.980s)
[203.919025] Subtest multi-client: SUCCESS (9.136s)
[204.052128] [029/133] (816s left) kms_hdr (static-toggle-suspend)
[204.145268] Starting subtest: static-toggle-suspend
[204.152100] Subtest static-toggle-suspend: SKIP (0.000s)
[204.217553] [030/133] (816s left) kms_cursor_edge_walk (256x256-right-edge)
[204.306298] Starting subtest: 256x256-right-edge
[204.308590] Starting dynamic subtest: pipe-A-eDP-1
[207.802378] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.496s)
[207.810477] Starting dynamic subtest: pipe-D-eDP-1
[210.920679] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.117s)
[210.922945] Subtest 256x256-right-edge: SUCCESS (6.616s)
[211.726226] [031/133] (808s left) i915_pm_rpm (sysfs-read)
[213.259493] Starting subtest: sysfs-read
[214.415582] Subtest sysfs-read: SUCCESS (1.156s)
[214.792771] [032/133] (805s left) gem_linear_blits (normal)
[215.092702] Starting subtest: normal
[219.002068] Subtest normal: SUCCESS (3.908s)
[219.135066] [033/133] (801s left) kms_setmode (invalid-clone-single-crtc-stealing)
[219.241772] Starting subtest: invalid-clone-single-crtc-stealing
[219.248366] Subtest invalid-clone-single-crtc-stealing: SKIP (0.000s)
[219.346519] [034/133] (801s left) gem_exec_schedule (independent)
[219.431781] Starting subtest: independent
[219.433729] Starting dynamic subtest: rcs0
[220.886756] Dynamic subtest rcs0: SUCCESS (1.461s)
[220.898096] Starting dynamic subtest: vcs0
[222.949556] Dynamic subtest vcs0: SUCCESS (2.061s)
[222.960943] Starting dynamic subtest: vcs1
[224.930458] Dynamic subtest vcs1: SUCCESS (1.979s)
[224.941988] Starting dynamic subtest: vecs0
[226.914899] Dynamic subtest vecs0: SUCCESS (1.982s)
[226.928067] Starting dynamic subtest: ccs0
[228.886052] Dynamic subtest ccs0: SUCCESS (1.969s)
[228.889064] Subtest independent: SUCCESS (9.462s)
[229.187855] [035/133] (791s left) dumb_buffer (create-valid-dumb)
[229.251347] Starting subtest: create-valid-dumb
[229.253272] Subtest create-valid-dumb: SUCCESS (0.000s)
[229.338290] [036/133] (791s left) kms_chamelium_hpd (hdmi-hpd-with-enabled-mode)
[229.744093] Subtest hdmi-hpd-with-enabled-mode: SKIP (0.000s)
[230.585317] [037/133] (790s left) kms_big_fb (x-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[230.693042] Starting subtest: x-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[231.574701] Subtest x-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SUCCESS (0.883s)
[231.748135] [038/133] (788s left) kms_getfb (getfb-addfb-different-handles)
[231.836852] Starting subtest: getfb-addfb-different-handles
[231.839118] Subtest getfb-addfb-different-handles: SUCCESS (0.000s)
[231.934629] [039/133] (788s left) kms_plane_scaling (planes-upscale-factor-0-25)
[232.016311] Starting subtest: planes-upscale-factor-0-25
[232.018480] Starting dynamic subtest: pipe-A
[232.078700] Dynamic subtest pipe-A: SUCCESS (0.062s)
[232.088625] Starting dynamic subtest: pipe-B
[233.227926] Dynamic subtest pipe-B: SUCCESS (1.149s)
[233.238505] Starting dynamic subtest: pipe-C
[234.330871] Dynamic subtest pipe-C: SUCCESS (1.102s)
[234.339440] Starting dynamic subtest: pipe-D
[235.467984] Dynamic subtest pipe-D: SUCCESS (1.136s)
[235.470347] Subtest planes-upscale-factor-0-25: SUCCESS (3.452s)
[236.645606] [040/133] (784s left) kms_lease (lease-get)
[236.734275] Starting subtest: lease-get
[236.736751] Starting dynamic subtest: pipe-A-eDP-1
[236.739066] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[236.749450] Starting dynamic subtest: pipe-B-eDP-1
[236.751634] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[236.759718] Starting dynamic subtest: pipe-C-eDP-1
[236.761830] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[236.770215] Starting dynamic subtest: pipe-D-eDP-1
[236.772341] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[236.774496] Subtest lease-get: SUCCESS (0.009s)
[236.836900] [041/133] (783s left) kms_addfb_basic (size-max)
[236.933735] Starting subtest: size-max
[236.935861] Subtest size-max: SUCCESS (0.000s)
[237.030758] [042/133] (783s left) gem_exec_schedule (u-semaphore-user)
[237.105737] Starting subtest: u-semaphore-user
[237.156050] Subtest u-semaphore-user: SUCCESS (0.057s)
[238.969869] [043/133] (781s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[239.056209] Starting subtest: fbc-rgb101010-draw-mmap-wc
[243.632991] Subtest fbc-rgb101010-draw-mmap-wc: SUCCESS (4.579s)
[244.827716] [044/133] (776s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling)
[244.925040] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling
[244.929529] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.000s)
[245.017191] [045/133] (775s left) perf (blocking-parameterized)
[245.148021] Starting subtest: blocking-parameterized
[265.170108] Subtest blocking-parameterized: SUCCESS (20.021s)
[265.219248] [046/133] (755s left) gem_lmem_swapping (parallel-random-verify)
[265.258074] Subtest parallel-random-verify: SKIP (0.000s)
[265.308161] [047/133] (755s left) gem_create (hog-create)
[265.363975] Starting subtest: hog-create
[265.366605] Starting dynamic subtest: smem0
[298.898547] Dynamic subtest smem0: SUCCESS (33.531s)
[298.901384] Subtest hog-create: SUCCESS (33.533s)
[299.086790] [048/133] (722s left) api_intel_bb (intel-bb-blit-x)
[299.145964] Starting subtest: intel-bb-blit-x
[302.702679] Subtest intel-bb-blit-x: SUCCESS (3.556s)
[302.802764] [049/133] (718s left) kms_pipe_crc_basic (suspend-read-crc)
[302.901812] Starting subtest: suspend-read-crc
[302.904061] Starting dynamic subtest: pipe-A-eDP-1
[321.302283] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.668s)
[321.311944] Starting dynamic subtest: pipe-B-eDP-1
[339.282660] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.193s)
[339.292476] Starting dynamic subtest: pipe-C-eDP-1
[357.252417] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.124s)
[357.262530] Starting dynamic subtest: pipe-D-eDP-1
[375.246230] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.079s)
[375.248557] Subtest suspend-read-crc: SUCCESS (12.070s)
[376.059402] [050/133] (645s left) gem_exec_whisper (basic-fds-priority-all)
[376.148501] Starting subtest: basic-fds-priority-all
[397.690455] Subtest basic-fds-priority-all: SUCCESS (21.723s)
[397.870529] [051/133] (623s left) gem_exec_balancer (full)
[397.927649] Starting subtest: full
[402.288021] Subtest full: SUCCESS (4.366s)
[402.588670] [052/133] (618s left) kms_dp_link_training (uhbr-sst)
[402.679561] Starting subtest: uhbr-sst
[402.687944] Subtest uhbr-sst: SKIP (0.000s)
[402.762197] [053/133] (618s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-fullscreen)
[402.852677] Starting subtest: psr-2p-primscrn-spr-indfb-fullscreen
[402.856978] Subtest psr-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s)
[402.951229] [054/133] (618s left) kms_ccs (crc-primary-basic-4-tiled-bmg-ccs)
[403.054327] Starting subtest: crc-primary-basic-4-tiled-bmg-ccs
[403.058816] Subtest crc-primary-basic-4-tiled-bmg-ccs: SKIP (0.000s)
[404.161324] [055/133] (617s left) gem_exec_flush (basic-wb-pro-default)
[404.218972] Starting subtest: basic-wb-pro-default
[409.683465] Subtest basic-wb-pro-default: SUCCESS (5.463s)
[409.874937] [056/133] (611s left) kms_cursor_legacy (flip-vs-cursor-toggle)
[409.998039] Starting subtest: flip-vs-cursor-toggle
[418.698040] Subtest flip-vs-cursor-toggle: SUCCESS (8.696s)
[419.498260] [057/133] (601s left) kms_psr (fbc-pr-cursor-mmap-cpu)
[419.598345] Starting subtest: fbc-pr-cursor-mmap-cpu
[419.602721] Subtest fbc-pr-cursor-mmap-cpu: SKIP (0.000s)
[419.671524] [058/133] (601s left) drm_read (empty-block)
[419.809536] Starting subtest: empty-block
[420.811069] Subtest empty-block: SUCCESS (1.000s)
[420.947101] [059/133] (600s left) kms_psr (fbc-pr-sprite-mmap-gtt)
[421.037305] Starting subtest: fbc-pr-sprite-mmap-gtt
[421.041634] Subtest fbc-pr-sprite-mmap-gtt: SKIP (0.000s)
[421.106859] [060/133] (600s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-shrfb-draw-mmap-wc)
[421.202134] Starting subtest: fbc-1p-offscreen-pri-shrfb-draw-mmap-wc
[425.222186] Subtest fbc-1p-offscreen-pri-shrfb-draw-mmap-wc: SUCCESS (4.021s)
[426.400055] [061/133] (595s left) vgem_basic (bad-handle)
[426.597089] Starting subtest: bad-handle
[426.599390] Subtest bad-handle: SUCCESS (0.000s)
[426.651370] [FACT vgem_basic (bad-handle)] new: kernel.kmod_is_loaded.vgem: true
[426.654866] [062/133] (595s left) gem_exec_params (mmapped)
[426.711559] Starting subtest: mmapped
[426.716392] Subtest mmapped: SUCCESS (0.003s)
[426.836004] [063/133] (594s left) kms_pm_dc (dc6-psr)
[427.937137] Starting subtest: dc6-psr
[430.849648] Subtest dc6-psr: SUCCESS (2.913s)
[431.729138] [064/133] (590s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[431.781549] Starting subtest: framebuffer-vs-set-tiling
[431.786502] Subtest framebuffer-vs-set-tiling: SKIP (0.000s)
[431.937072] [065/133] (589s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-pgflip-blt)
[432.031333] Starting subtest: fbcpsr-2p-scndscrn-indfb-pgflip-blt
[432.035454] Subtest fbcpsr-2p-scndscrn-indfb-pgflip-blt: SKIP (0.000s)
[432.134811] [066/133] (589s left) gem_softpin (evict-prime-sanity-check)
[432.194256] Starting subtest: evict-prime-sanity-check
[432.196574] Starting dynamic subtest: rcs0
[433.336533] Dynamic subtest rcs0: SUCCESS (1.142s)
[433.346402] Starting dynamic subtest: bcs0
[434.455131] Dynamic subtest bcs0: SUCCESS (1.117s)
[434.471638] Starting dynamic subtest: vcs0
[436.351378] Dynamic subtest vcs0: SUCCESS (1.893s)
[436.368872] Starting dynamic subtest: vcs1
[438.338040] Dynamic subtest vcs1: SUCCESS (1.985s)
[438.349997] Starting dynamic subtest: vecs0
[440.315058] Dynamic subtest vecs0: SUCCESS (1.975s)
[440.327175] Starting dynamic subtest: ccs0
[441.432118] Dynamic subtest ccs0: SUCCESS (1.116s)
[441.441256] Starting dynamic subtest: all
[442.556570] Dynamic subtest all: SUCCESS (1.124s)
[442.559083] Subtest evict-prime-sanity-check: SUCCESS (10.365s)
[442.637820] [067/133] (579s left) kms_cursor_legacy (torture-move)
[442.760826] Starting subtest: torture-move
[442.762951] Starting dynamic subtest: pipe-A
[448.661375] Dynamic subtest pipe-A: SUCCESS (5.898s)
[448.676261] Starting dynamic subtest: pipe-B
[455.672044] Dynamic subtest pipe-B: SUCCESS (7.010s)
[455.683936] Starting dynamic subtest: pipe-C
[462.687544] Dynamic subtest pipe-C: SUCCESS (7.016s)
[462.701459] Starting dynamic subtest: pipe-D
[468.915462] Dynamic subtest pipe-D: SUCCESS (6.228s)
[468.930818] Starting dynamic subtest: all-pipes
[475.525138] Dynamic subtest all-pipes: SUCCESS (6.605s)
[475.527466] Subtest torture-move: SUCCESS (32.769s)
[475.682495] [068/133] (546s left) kms_flip (plain-flip-fb-recreate-interruptible)
[475.776967] Starting subtest: plain-flip-fb-recreate-interruptible
[475.779250] Starting dynamic subtest: A-eDP1
[484.605377] Dynamic subtest A-eDP1: SUCCESS (8.824s)
[484.617465] Starting dynamic subtest: B-eDP1
[493.451454] Dynamic subtest B-eDP1: SUCCESS (8.841s)
[493.466677] Starting dynamic subtest: C-eDP1
[502.275956] Dynamic subtest C-eDP1: SUCCESS (8.822s)
[502.288818] Starting dynamic subtest: D-eDP1
[511.103204] Dynamic subtest D-eDP1: SUCCESS (8.824s)
[511.107893] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.324s)
[512.277675] [069/133] (509s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-cpu)
[512.387281] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-cpu
[512.391594] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-cpu: SKIP (0.000s)
[512.489884] [070/133] (509s left) perf_pmu (all-busy-check-all)
[512.531499] Starting subtest: all-busy-check-all
[514.306698] Subtest all-busy-check-all: SUCCESS (1.774s)
[514.412113] [071/133] (507s left) kms_plane (pixel-format-4-tiled-mtl-mc-ccs-modifier)
[514.510931] Starting subtest: pixel-format-4-tiled-mtl-mc-ccs-modifier
[514.535518] Starting dynamic subtest: pipe-A-plane-0
[514.957734] Dynamic subtest pipe-A-plane-0: SUCCESS (0.422s)
[514.969272] Starting dynamic subtest: pipe-A-plane-3
[515.213326] Dynamic subtest pipe-A-plane-3: SUCCESS (0.255s)
[515.222926] Starting dynamic subtest: pipe-A-plane-5
[515.227336] Dynamic subtest pipe-A-plane-5: SKIP (0.000s)
[516.288651] Starting dynamic subtest: pipe-B-plane-0
[516.702844] Dynamic subtest pipe-B-plane-0: SUCCESS (0.422s)
[516.713091] Starting dynamic subtest: pipe-B-plane-3
[516.958601] Dynamic subtest pipe-B-plane-3: SUCCESS (0.253s)
[516.970451] Starting dynamic subtest: pipe-B-plane-5
[516.974980] Dynamic subtest pipe-B-plane-5: SKIP (0.000s)
[517.277911] Subtest pixel-format-4-tiled-mtl-mc-ccs-modifier: SUCCESS (2.770s)
[518.087111] [072/133] (503s left) gem_ctx_param (invalid-get-ringsize)
[518.144796] Starting subtest: invalid-get-ringsize
[518.146989] Subtest invalid-get-ringsize: SUCCESS (0.001s)
[518.256559] [073/133] (503s left) gem_eio (in-flight-contexts-1us)
[518.458640] Starting subtest: in-flight-contexts-1us
[532.377175] Subtest in-flight-contexts-1us: SUCCESS (13.918s)
[532.544557] [074/133] (489s left) kms_frontbuffer_tracking (fbc-1p-rte)
[532.646366] Starting subtest: fbc-1p-rte
[538.148728] Subtest fbc-1p-rte: SUCCESS (5.507s)
[539.283032] [075/133] (482s left) gem_pxp (reject-modify-context-protection-off-2)
[539.414228] Starting subtest: reject-modify-context-protection-off-2
[539.416871] Subtest reject-modify-context-protection-off-2: SUCCESS (0.001s)
[539.528244] [076/133] (482s left) drm_read (short-buffer-block)
[539.683261] Starting subtest: short-buffer-block
[539.685731] Subtest short-buffer-block: SUCCESS (0.000s)
[539.820128] [077/133] (482s left) kms_ccs (random-ccs-data-4-tiled-dg2-rc-ccs)
[539.913147] Starting subtest: random-ccs-data-4-tiled-dg2-rc-ccs
[539.915295] Starting dynamic subtest: pipe-A-eDP-1
[539.939289] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[539.950385] Starting dynamic subtest: pipe-B-eDP-1
[539.972880] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[539.982106] Starting dynamic subtest: pipe-C-eDP-1
[540.005283] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[540.014133] Starting dynamic subtest: pipe-D-eDP-1
[540.036768] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[540.040869] Subtest random-ccs-data-4-tiled-dg2-rc-ccs: SKIP (0.005s)
[542.239820] [078/133] (480s left) kms_plane_scaling (plane-downscale-factor-0-75-with-modifiers)
[542.340651] Starting subtest: plane-downscale-factor-0-75-with-modifiers
[542.342998] Starting dynamic subtest: pipe-A
[542.679518] Dynamic subtest pipe-A: SUCCESS (0.341s)
[542.689627] Starting dynamic subtest: pipe-B
[544.166126] Dynamic subtest pipe-B: SUCCESS (1.486s)
[544.176640] Starting dynamic subtest: pipe-C
[545.585332] Dynamic subtest pipe-C: SUCCESS (1.418s)
[545.595165] Starting dynamic subtest: pipe-D
[547.015335] Dynamic subtest pipe-D: SUCCESS (1.429s)
[547.017724] Subtest plane-downscale-factor-0-75-with-modifiers: SUCCESS (4.678s)
[548.176728] [079/133] (474s left) kms_plane (pixel-format-4-tiled-dg2-rc-ccs-cc-modifier)
[548.260812] Starting subtest: pixel-format-4-tiled-dg2-rc-ccs-cc-modifier
[548.264892] Subtest pixel-format-4-tiled-dg2-rc-ccs-cc-modifier: SKIP (0.000s)
[548.340763] [080/133] (474s left) gem_exec_alignment (pi)
[548.404938] Starting subtest: pi
[602.813741] Subtest pi: SUCCESS (54.417s)
[603.898597] [081/133] (418s left) kms_cursor_crc (cursor-onscreen-256x256)
[604.193555] Starting subtest: cursor-onscreen-256x256
[604.198374] Starting dynamic subtest: pipe-A-eDP-1
[606.347435] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.148s)
[606.377310] Starting dynamic subtest: pipe-D-eDP-1
[609.151953] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.780s)
[609.154147] Subtest cursor-onscreen-256x256: SUCCESS (4.954s)
[610.028227] [082/133] (412s left) syncobj_wait (single-wait-for-submit-signaled)
[610.089335] Starting subtest: single-wait-for-submit-signaled
[610.094743] Subtest single-wait-for-submit-signaled: SUCCESS (0.000s)
[610.176944] [083/133] (412s left) kms_psr (psr2-sprite-blt)
[610.271849] Starting subtest: psr2-sprite-blt
[610.273947] Starting dynamic subtest: eDP-1
[612.017369] Dynamic subtest eDP-1: SUCCESS (1.744s)
[612.019726] Subtest psr2-sprite-blt: SUCCESS (1.745s)
[612.886050] [084/133] (409s left) syncobj_timeline (multi-wait-all-available-submitted)
[612.943955] Starting subtest: multi-wait-all-available-submitted
[612.946353] Subtest multi-wait-all-available-submitted: SUCCESS (0.000s)
[613.048025] [085/133] (409s left) gen3_render_tiledx_blits
[613.194647] [086/133] (409s left) kms_cursor_crc (cursor-rapid-movement-256x256)
[613.447449] Starting subtest: cursor-rapid-movement-256x256
[613.452110] Starting dynamic subtest: pipe-A-eDP-1
[614.009075] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.556s)
[614.042066] Starting dynamic subtest: pipe-D-eDP-1
[615.185610] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.153s)
[615.188006] Subtest cursor-rapid-movement-256x256: SUCCESS (1.738s)
[616.048924] [087/133] (406s left) kms_psr (pr-primary-blt)
[616.155502] Starting subtest: pr-primary-blt
[616.159839] Subtest pr-primary-blt: SKIP (0.000s)
[616.248979] [088/133] (406s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-render)
[616.342743] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-render
[616.346495] Subtest fbc-2p-scndscrn-pri-indfb-draw-render: SKIP (0.000s)
[616.434167] [089/133] (406s left) gem_userptr_blits (coherency-sync)
[616.495408] Starting subtest: coherency-sync
[616.645000] Subtest coherency-sync: SKIP (0.115s)
[616.743846] [090/133] (406s left) kms_chamelium_frames (dp-frame-dump)
[617.165045] Subtest dp-frame-dump: SKIP (0.000s)
[617.947912] [091/133] (404s left) i915_selftest (live)
[621.347122] Starting subtest: live
[621.349893] Starting dynamic subtest: sanitycheck
[625.693068] Dynamic subtest sanitycheck: SUCCESS (4.343s)
[625.702369] Starting dynamic subtest: uncore
[629.990594] Dynamic subtest uncore: SUCCESS (4.295s)
[630.000373] Starting dynamic subtest: workarounds
[633.158527] Dynamic subtest workarounds: SUCCESS (3.165s)
[633.166917] Starting dynamic subtest: gt_engines
[636.260441] Dynamic subtest gt_engines: SUCCESS (3.100s)
[636.275779] Starting dynamic subtest: gt_timelines
[651.783105] Dynamic subtest gt_timelines: SUCCESS (15.519s)
[651.793883] Starting dynamic subtest: gt_contexts
[656.129130] Dynamic subtest gt_contexts: SUCCESS (4.344s)
[656.138682] Starting dynamic subtest: gt_lrc
[660.509204] Dynamic subtest gt_lrc: SUCCESS (4.378s)
[660.519112] Starting dynamic subtest: gt_mocs
[663.513464] Dynamic subtest gt_mocs: SUCCESS (3.002s)
[663.523629] Starting dynamic subtest: gt_pm
[670.284024] Dynamic subtest gt_pm: SUCCESS (6.768s)
[670.293351] Starting dynamic subtest: gt_heartbeat
[674.620860] Dynamic subtest gt_heartbeat: SUCCESS (4.334s)
[674.630923] Starting dynamic subtest: gt_tlb
[683.962115] Dynamic subtest gt_tlb: SUCCESS (9.340s)
[683.978408] Starting dynamic subtest: requests
[695.473306] Dynamic subtest requests: SUCCESS (11.510s)
[695.484065] Starting dynamic subtest: migrate
[701.251332] Dynamic subtest migrate: SUCCESS (5.776s)
[701.262552] Starting dynamic subtest: active
[705.567110] Dynamic subtest active: SUCCESS (4.314s)
[705.578102] Starting dynamic subtest: objects
[710.538771] Dynamic subtest objects: SUCCESS (4.970s)
[710.549061] Starting dynamic subtest: mman
[715.521279] Dynamic subtest mman: SUCCESS (4.980s)
[715.533801] Starting dynamic subtest: dmabuf
[719.845964] Dynamic subtest dmabuf: SUCCESS (4.323s)
[719.857538] Starting dynamic subtest: vma
[724.161686] Dynamic subtest vma: SUCCESS (4.313s)
[724.171264] Starting dynamic subtest: coherency
[729.483519] Dynamic subtest coherency: SUCCESS (5.321s)
[729.495465] Starting dynamic subtest: gtt
[741.275362] Dynamic subtest gtt: SUCCESS (11.791s)
[741.285177] Starting dynamic subtest: gem
[749.004354] Dynamic subtest gem: SUCCESS (7.729s)
[749.014517] Starting dynamic subtest: evict
[755.316827] Dynamic subtest evict: SUCCESS (6.311s)
[755.327539] Starting dynamic subtest: hugepages
[764.055249] Dynamic subtest hugepages: SUCCESS (8.737s)
[764.065136] Starting dynamic subtest: gem_contexts
[792.355477] Dynamic subtest gem_contexts: SUCCESS (28.303s)
[792.365967] Starting dynamic subtest: client
[796.696198] Dynamic subtest client: SUCCESS (4.341s)
[796.706241] Starting dynamic subtest: gem_migrate
[801.022619] Dynamic subtest gem_migrate: SUCCESS (4.325s)
[801.047680] Starting dynamic subtest: reset
[805.880950] Dynamic subtest reset: SUCCESS (4.858s)
[805.890100] Starting dynamic subtest: memory_region
[810.232730] Dynamic subtest memory_region: SUCCESS (4.349s)
[810.242873] Starting dynamic subtest: hangcheck
[823.480057] Dynamic subtest hangcheck: SUCCESS (13.249s)
[823.490171] Starting dynamic subtest: execlists
[827.827239] Dynamic subtest execlists: SUCCESS (4.345s)
[827.837491] Starting dynamic subtest: ring_submission
[832.214460] Dynamic subtest ring_submission: SUCCESS (4.386s)
[832.224587] Starting dynamic subtest: perf
[836.521599] Dynamic subtest perf: SUCCESS (4.306s)
[836.531472] Starting dynamic subtest: slpc
[850.530585] Dynamic subtest slpc: SUCCESS (14.009s)
[850.547733] Starting dynamic subtest: guc
[854.450230] Dynamic subtest guc: SUCCESS (3.919s)
[854.467880] Starting dynamic subtest: guc_multi_lrc
[858.786963] Dynamic subtest guc_multi_lrc: SUCCESS (4.336s)
[858.797055] Starting dynamic subtest: guc_hang
[863.723895] Dynamic subtest guc_hang: SUCCESS (4.936s)
[863.734490] Starting dynamic subtest: late_gt_pm
[868.086032] Dynamic subtest late_gt_pm: SUCCESS (4.361s)
[868.088693] Subtest live: SUCCESS (246.758s)
[868.117433] [FACT i915_selftest (live)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[868.118184] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true
[868.121425] [092/133] (154s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-wc)
[869.713021] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-mmap-wc
[869.717385] Subtest fbc-2p-primscrn-spr-indfb-draw-mmap-wc: SKIP (0.000s)
[869.822550] [FACT kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-wc)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[869.823850] [FACT kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-mmap-wc)] new: kernel.kmod_is_loaded.i915: true
[869.827562] [093/133] (153s left) kms_ccs (bad-aux-stride-4-tiled-mtl-mc-ccs)
[869.935162] Starting subtest: bad-aux-stride-4-tiled-mtl-mc-ccs
[869.937268] Starting dynamic subtest: pipe-A-eDP-1
[869.999479] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.065s)
[870.008360] Starting dynamic subtest: pipe-B-eDP-1
[870.061722] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.061s)
[870.070471] Starting dynamic subtest: pipe-C-eDP-1
[870.123715] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.060s)
[870.132413] Starting dynamic subtest: pipe-D-eDP-1
[870.186557] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.062s)
[870.188836] Subtest bad-aux-stride-4-tiled-mtl-mc-ccs: SUCCESS (0.254s)
[872.502421] [094/133] (150s left) perf (polling)
[872.643461] Starting subtest: polling
[872.645733] Starting dynamic subtest: 0-rcs0
[882.656077] Dynamic subtest 0-rcs0: SUCCESS (10.013s)
[882.665409] Starting dynamic subtest: 1-vcs1
[892.676051] Dynamic subtest 1-vcs1: SUCCESS (10.021s)
[892.678510] Subtest polling: SUCCESS (20.036s)
[892.727335] [095/133] (130s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-draw-mmap-wc)
[892.817904] Starting subtest: fbc-1p-primscrn-spr-indfb-draw-mmap-wc
[896.358144] Subtest fbc-1p-primscrn-spr-indfb-draw-mmap-wc: SUCCESS (3.544s)
[897.503749] [096/133] (125s left) syncobj_timeline (invalid-multi-wait-all-unsubmitted-submitted)
[897.573486] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[897.575904] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[897.687978] [097/133] (125s left) kms_prime (basic-crc-hybrid)
[897.775715] Subtest basic-crc-hybrid: SKIP (0.000s)
[897.894352] [098/133] (125s left) kms_cursor_legacy (cursorb-vs-flipb-atomic-transitions-varying-size)
[898.028982] Starting subtest: cursorB-vs-flipB-atomic-transitions-varying-size
[898.033508] Subtest cursorB-vs-flipB-atomic-transitions-varying-size: SKIP (0.001s)
[898.184771] [099/133] (125s left) kms_big_fb (x-tiled-8bpp-rotate-90)
[898.293610] Starting subtest: x-tiled-8bpp-rotate-90
[898.319760] Subtest x-tiled-8bpp-rotate-90: SKIP (0.025s)
[898.423595] [100/133] (124s left) gen9_exec_parse (unaligned-jump)
[898.484194] Subtest unaligned-jump: SKIP (0.000s)
[898.540846] [101/133] (124s left) perf_pmu (semaphore-wait)
[898.593672] Starting subtest: semaphore-wait
[898.595550] Starting dynamic subtest: rcs0
[899.108513] Dynamic subtest rcs0: SUCCESS (0.514s)
[899.120002] Starting dynamic subtest: bcs0
[899.621542] Dynamic subtest bcs0: SUCCESS (0.510s)
[899.632466] Starting dynamic subtest: vcs0
[900.135070] Dynamic subtest vcs0: SUCCESS (0.510s)
[900.147429] Starting dynamic subtest: vcs1
[900.648921] Dynamic subtest vcs1: SUCCESS (0.510s)
[900.660157] Starting dynamic subtest: vecs0
[901.164162] Dynamic subtest vecs0: SUCCESS (0.513s)
[901.178609] Starting dynamic subtest: ccs0
[901.679576] Dynamic subtest ccs0: SUCCESS (0.512s)
[901.682222] Subtest semaphore-wait: SUCCESS (3.087s)
[901.799048] [102/133] (121s left) syncobj_wait (invalid-reset-one-illegal-handle)
[901.856464] Starting subtest: invalid-reset-one-illegal-handle
[901.858736] Subtest invalid-reset-one-illegal-handle: SUCCESS (0.000s)
[901.958526] [103/133] (121s left) gem_render_copy (yf-tiled-to-vebox-yf-tiled)
[902.011763] Starting subtest: yf-tiled-to-vebox-yf-tiled
[902.015951] Subtest yf-tiled-to-vebox-yf-tiled: SKIP (0.000s)
[902.198519] [104/133] (121s left) kms_flip (single-buffer-flip-vs-dpms-off-vs-modeset-interruptible)
[902.293606] Starting subtest: single-buffer-flip-vs-dpms-off-vs-modeset-interruptible
[902.295933] Starting dynamic subtest: A-eDP1
[906.746322] Dynamic subtest A-eDP1: SUCCESS (4.448s)
[906.757689] Starting dynamic subtest: B-eDP1
[909.511879] Dynamic subtest B-eDP1: SUCCESS (2.765s)
[909.521874] Starting dynamic subtest: C-eDP1
[912.640000] Dynamic subtest C-eDP1: SUCCESS (3.128s)
[912.649859] Starting dynamic subtest: D-eDP1
[915.758797] Dynamic subtest D-eDP1: SUCCESS (3.119s)
[915.760954] Subtest single-buffer-flip-vs-dpms-off-vs-modeset-interruptible: SUCCESS (13.469s)
[916.558737] [105/133] (106s left) kms_frontbuffer_tracking (fbcpsr-rgb101010-draw-render)
[916.675474] Starting subtest: fbcpsr-rgb101010-draw-render
[923.424854] Subtest fbcpsr-rgb101010-draw-render: SUCCESS (6.755s)
[923.540486] [106/133] (100s left) i915_drm_fdinfo (virtual-busy-idle-all)
[923.584236] Starting subtest: virtual-busy-idle-all
[923.588459] Subtest virtual-busy-idle-all: SKIP (0.000s)
[923.646576] [107/133] ( 99s left) kms_pipe_b_c_ivb (pipe-b-dpms-off-modeset-pipe-c)
[923.695898] Subtest pipe-B-dpms-off-modeset-pipe-C: SKIP (0.000s)
[923.756724] [108/133] ( 99s left) kms_psr (fbc-psr-dpms)
[923.855600] Starting subtest: fbc-psr-dpms
[923.857871] Starting dynamic subtest: eDP-1
[923.862132] Dynamic subtest eDP-1: SKIP (0.000s)
[923.866320] Subtest fbc-psr-dpms: SKIP (0.001s)
[923.930824] [109/133] ( 99s left) gem_render_linear_blits (basic)
[923.990321] Starting subtest: basic
[924.016102] Subtest basic: SUCCESS (0.025s)
[924.100604] [110/133] ( 99s left) kms_frontbuffer_tracking (psr-rgb101010-draw-pwrite)
[924.193597] Starting subtest: psr-rgb101010-draw-pwrite
[931.889097] Subtest psr-rgb101010-draw-pwrite: SUCCESS (7.698s)
[932.013882] [111/133] ( 91s left) intel_hwmon (hwmon-read)
[932.079385] Subtest hwmon-read: SKIP (0.000s)
[932.144336] [112/133] ( 91s left) kms_psr2_sf (psr2-cursor-plane-move-continuous-exceed-fully-sf)
[932.251249] Starting subtest: psr2-cursor-plane-move-continuous-exceed-fully-sf
[932.253349] Starting dynamic subtest: pipe-A-eDP-1
[943.228727] Dynamic subtest pipe-A-eDP-1: SUCCESS (10.984s)
[943.238921] Starting dynamic subtest: pipe-B-eDP-1
[954.925989] Dynamic subtest pipe-B-eDP-1: SUCCESS (11.698s)
[954.928298] Subtest psr2-cursor-plane-move-continuous-exceed-fully-sf: SUCCESS (22.685s)
[955.791309] [113/133] ( 68s left) kms_frontbuffer_tracking (psr-1p-primscrn-shrfb-plflip-blt)
[955.897436] Starting subtest: psr-1p-primscrn-shrfb-plflip-blt
[963.488385] Subtest psr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.594s)
[963.638269] [114/133] ( 60s left) gem_ctx_persistence (processes)
[963.702776] Starting subtest: processes
[965.312026] Subtest processes: SUCCESS (1.610s)
[965.404282] [115/133] ( 58s left) gem_exec_reloc (basic-gtt)
[965.474710] Subtest basic-gtt: SKIP (0.000s)
[965.560392] [116/133] ( 58s left) syncobj_eventfd (invalid-bad-flags)
[965.614345] Starting subtest: invalid-bad-flags
[965.616736] Subtest invalid-bad-flags: SUCCESS (0.000s)
[965.737090] [117/133] ( 58s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-render)
[965.834804] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-render
[965.838872] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[965.932059] [118/133] ( 58s left) kms_atomic (crtc-invalid-params-fence)
[966.028605] Starting subtest: crtc-invalid-params-fence
[966.030508] Starting dynamic subtest: pipe-A-eDP-1
[967.162261] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.133s)
[967.164730] Subtest crtc-invalid-params-fence: SUCCESS (1.135s)
[967.536855] [119/133] ( 56s left) dumb_buffer (map-valid)
[967.608275] Starting subtest: map-valid
[967.610698] Subtest map-valid: SUCCESS (0.000s)
[967.713996] [120/133] ( 56s left) gem_exec_reloc (basic-wc-read-active)
[967.768285] Subtest basic-wc-read-active: SKIP (0.000s)
[967.841305] [121/133] ( 56s left) kms_frontbuffer_tracking (psr-1p-pri-indfb-multidraw)
[967.937962] Starting subtest: psr-1p-pri-indfb-multidraw
[990.955765] Subtest psr-1p-pri-indfb-multidraw: SUCCESS (23.026s)
[991.081302] [122/133] ( 33s left) kms_color_pipeline (plane-ctm3x4)
[991.184832] Starting subtest: plane-ctm3x4
[991.354429] Starting dynamic subtest: pipe-A-plane-0
[991.531526] Dynamic subtest pipe-A-plane-0: SUCCESS (0.178s)
[991.541159] Starting dynamic subtest: pipe-A-plane-1
[991.687143] Dynamic subtest pipe-A-plane-1: SUCCESS (0.155s)
[991.697336] Starting dynamic subtest: pipe-A-plane-2
[991.820410] Dynamic subtest pipe-A-plane-2: SUCCESS (0.133s)
[993.055084] Starting dynamic subtest: pipe-B-plane-0
[993.214191] Dynamic subtest pipe-B-plane-0: SUCCESS (0.166s)
[993.225115] Starting dynamic subtest: pipe-B-plane-1
[993.369706] Dynamic subtest pipe-B-plane-1: SUCCESS (0.155s)
[993.379503] Starting dynamic subtest: pipe-B-plane-2
[993.524729] Dynamic subtest pipe-B-plane-2: SUCCESS (0.154s)
[994.706645] Starting dynamic subtest: pipe-C-plane-0
[994.819775] Dynamic subtest pipe-C-plane-0: SUCCESS (0.122s)
[994.830054] Starting dynamic subtest: pipe-C-plane-1
[994.931437] Dynamic subtest pipe-C-plane-1: SUCCESS (0.110s)
[994.941809] Starting dynamic subtest: pipe-C-plane-2
[995.053846] Dynamic subtest pipe-C-plane-2: SUCCESS (0.121s)
[996.209715] Starting dynamic subtest: pipe-D-plane-0
[996.312562] Dynamic subtest pipe-D-plane-0: SUCCESS (0.111s)
[996.322377] Starting dynamic subtest: pipe-D-plane-1
[996.445855] Dynamic subtest pipe-D-plane-1: SUCCESS (0.133s)
[996.455620] Starting dynamic subtest: pipe-D-plane-2
[996.557385] Dynamic subtest pipe-D-plane-2: SUCCESS (0.110s)
[996.850981] Subtest plane-ctm3x4: SUCCESS (5.666s)
[997.683782] [123/133] ( 26s left) kms_psr2_sf (fbc-pr-cursor-plane-move-continuous-exceed-fully-sf)
[997.776417] Starting subtest: fbc-pr-cursor-plane-move-continuous-exceed-fully-sf
[997.781710] Subtest fbc-pr-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[997.843926] [124/133] ( 26s left) gem_exec_big (single)
[997.915151] Starting subtest: single
[1001.390417] Subtest single: FAIL (3.416s)
[1001.431101] [125/133] ( 22s left) kms_flip_scaled_crc (flip-32bpp-xtile-to-64bpp-xtile-upscaling)
[1001.564847] Starting subtest: flip-32bpp-xtile-to-64bpp-xtile-upscaling
[1001.567201] Starting dynamic subtest: pipe-A-default-mode
[1004.299338] Dynamic subtest pipe-A-default-mode: SUCCESS (2.736s)
[1004.301711] Subtest flip-32bpp-xtile-to-64bpp-xtile-upscaling: SUCCESS (2.737s)
[1005.173036] [126/133] ( 19s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[1005.274430] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[1005.278596] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[1005.366563] [127/133] ( 19s left) gem_exec_fence (syncobj-channel)
[1005.785598] Starting subtest: syncobj-channel
[1006.803292] Subtest syncobj-channel: SUCCESS (1.015s)
[1007.418495] [128/133] ( 17s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip)
[1007.523407] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip
[1007.527837] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-hflip-async-flip: SKIP (0.000s)
[1007.611201] [129/133] ( 16s left) gem_pwrite (basic-random)
[1007.672462] Subtest basic-random: SKIP (0.000s)
[1007.734533] [130/133] ( 16s left) syncobj_wait (reset-unsignaled)
[1007.792354] Starting subtest: reset-unsignaled
[1007.794798] Subtest reset-unsignaled: SUCCESS (0.000s)
[1007.896816] [131/133] ( 16s left) api_intel_allocator (reloc-allocator)
[1007.965212] Starting subtest: reloc-allocator
[1007.967478] Starting dynamic subtest: basic
[1007.969787] Dynamic subtest basic: SUCCESS (0.005s)
[1007.982127] Starting dynamic subtest: parallel-one
[1007.984335] Dynamic subtest parallel-one: SUCCESS (0.008s)
[1007.994120] Starting dynamic subtest: print
[1007.996314] Dynamic subtest print: SUCCESS (0.000s)
[1008.005780] Starting dynamic subtest: reuse
[1008.008065] Dynamic subtest reuse: SUCCESS (0.000s)
[1008.017402] Starting dynamic subtest: fork-reopen-allocator
[1008.019637] Dynamic subtest fork-reopen-allocator: SUCCESS (0.012s)
[1008.021873] Subtest reloc-allocator: SUCCESS (0.028s)
[1008.125176] [132/133] ( 16s left) kms_big_fb (4-tiled-max-hw-stride-64bpp-rotate-180)
[1008.235902] Starting subtest: 4-tiled-max-hw-stride-64bpp-rotate-180
[1009.260132] Subtest 4-tiled-max-hw-stride-64bpp-rotate-180: SUCCESS (1.024s)
[1009.423785] [133/133] ( 15s left) gen9_exec_parse (allowed-single)
[1009.482278] Subtest allowed-single: SKIP (0.000s)
[1009.557892] Closing watchdogs
results: parsing output: 0/ for test: kms_psr
results: parsing output: 1/ for test: kms_addfb_basic
results: parsing output: 2/ for test: kms_chamelium_audio
results: parsing output: 3/ for test: gem_lmem_swapping
results: parsing output: 4/ for test: kms_sequence
results: parsing output: 5/ for test: gem_mmap_offset
results: parsing output: 6/ for test: gem_mmap
results: parsing output: 7/ for test: kms_ccs
results: parsing output: 8/ for test: gem_ctx_bad_destroy
results: parsing output: 9/ for test: kms_frontbuffer_tracking
results: parsing output: 10/ for test: kms_flip
results: parsing output: 11/ for test: kms_vblank
results: parsing output: 12/ for test: kms_big_fb
results: parsing output: 13/ for test: syncobj_wait
results: parsing output: 14/ for test: gem_wait
results: parsing output: 15/ for test: syncobj_timeline
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_content_protection
results: parsing output: 18/ for test: kms_big_fb
results: parsing output: 19/ for test: kms_cursor_legacy
results: parsing output: 20/ for test: gem_userptr_blits
results: parsing output: 21/ for test: kms_ccs
results: parsing output: 22/ for test: syncobj_timeline
results: parsing output: 23/ for test: kms_frontbuffer_tracking
results: parsing output: 24/ for test: kms_cursor_legacy
results: parsing output: 25/ for test: prime_mmap
results: parsing output: 26/ for test: gem_ctx_param
results: parsing output: 27/ for test: perf_pmu
results: parsing output: 28/ for test: kms_hdr
results: parsing output: 29/ for test: kms_cursor_edge_walk
results: parsing output: 30/ for test: i915_pm_rpm
results: parsing output: 31/ for test: gem_linear_blits
results: parsing output: 32/ for test: kms_setmode
results: parsing output: 33/ for test: gem_exec_schedule
results: parsing output: 34/ for test: dumb_buffer
results: parsing output: 35/ for test: kms_chamelium_hpd
results: parsing output: 36/ for test: kms_big_fb
results: parsing output: 37/ for test: kms_getfb
results: parsing output: 38/ for test: kms_plane_scaling
results: parsing output: 39/ for test: kms_lease
results: parsing output: 40/ for test: kms_addfb_basic
results: parsing output: 41/ for test: gem_exec_schedule
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: kms_flip_scaled_crc
results: parsing output: 44/ for test: perf
results: parsing output: 45/ for test: gem_lmem_swapping
results: parsing output: 46/ for test: gem_create
results: parsing output: 47/ for test: api_intel_bb
results: parsing output: 48/ for test: kms_pipe_crc_basic
results: parsing output: 49/ for test: gem_exec_whisper
results: parsing output: 50/ for test: gem_exec_balancer
results: parsing output: 51/ for test: kms_dp_link_training
results: parsing output: 52/ for test: kms_frontbuffer_tracking
results: parsing output: 53/ for test: kms_ccs
results: parsing output: 54/ for test: gem_exec_flush
results: parsing output: 55/ for test: kms_cursor_legacy
results: parsing output: 56/ for test: kms_psr
results: parsing output: 57/ for test: drm_read
results: parsing output: 58/ for test: kms_psr
results: parsing output: 59/ for test: kms_frontbuffer_tracking
results: parsing output: 60/ for test: vgem_basic
results: parsing output: 61/ for test: gem_exec_params
results: parsing output: 62/ for test: kms_pm_dc
results: parsing output: 63/ for test: kms_addfb_basic
results: parsing output: 64/ for test: kms_frontbuffer_tracking
results: parsing output: 65/ for test: gem_softpin
results: parsing output: 66/ for test: kms_cursor_legacy
results: parsing output: 67/ for test: kms_flip
results: parsing output: 68/ for test: kms_frontbuffer_tracking
results: parsing output: 69/ for test: perf_pmu
results: parsing output: 70/ for test: kms_plane
results: parsing output: 71/ for test: gem_ctx_param
results: parsing output: 72/ for test: gem_eio
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: gem_pxp
results: parsing output: 75/ for test: drm_read
results: parsing output: 76/ for test: kms_ccs
results: parsing output: 77/ for test: kms_plane_scaling
results: parsing output: 78/ for test: kms_plane
results: parsing output: 79/ for test: gem_exec_alignment
results: parsing output: 80/ for test: kms_cursor_crc
results: parsing output: 81/ for test: syncobj_wait
results: parsing output: 82/ for test: kms_psr
results: parsing output: 83/ for test: syncobj_timeline
results: parsing output: 84/ for test: gen3_render_tiledx_blits
results: parsing output: 85/ for test: kms_cursor_crc
results: parsing output: 86/ for test: kms_psr
results: parsing output: 87/ for test: kms_frontbuffer_tracking
results: parsing output: 88/ for test: gem_userptr_blits
results: parsing output: 89/ for test: kms_chamelium_frames
results: parsing output: 90/ for test: i915_selftest
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_ccs
results: parsing output: 93/ for test: perf
results: parsing output: 94/ for test: kms_frontbuffer_tracking
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: kms_prime
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: kms_big_fb
results: parsing output: 99/ for test: gen9_exec_parse
results: parsing output: 100/ for test: perf_pmu
results: parsing output: 101/ for test: syncobj_wait
results: parsing output: 102/ for test: gem_render_copy
results: parsing output: 103/ for test: kms_flip
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: i915_drm_fdinfo
results: parsing output: 106/ for test: kms_pipe_b_c_ivb
results: parsing output: 107/ for test: kms_psr
results: parsing output: 108/ for test: gem_render_linear_blits
results: parsing output: 109/ for test: kms_frontbuffer_tracking
results: parsing output: 110/ for test: intel_hwmon
results: parsing output: 111/ for test: kms_psr2_sf
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: gem_ctx_persistence
results: parsing output: 114/ for test: gem_exec_reloc
results: parsing output: 115/ for test: syncobj_eventfd
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: kms_atomic
results: parsing output: 118/ for test: dumb_buffer
results: parsing output: 119/ for test: gem_exec_reloc
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_color_pipeline
results: parsing output: 122/ for test: kms_psr2_sf
results: parsing output: 123/ for test: gem_exec_big
results: parsing output: 124/ for test: kms_flip_scaled_crc
results: parsing output: 125/ for test: kms_frontbuffer_tracking
results: parsing output: 126/ for test: gem_exec_fence
results: parsing output: 127/ for test: kms_big_fb
results: parsing output: 128/ for test: gem_pwrite
results: parsing output: 129/ for test: syncobj_wait
results: parsing output: 130/ for test: api_intel_allocator
results: parsing output: 131/ for test: kms_big_fb
results: parsing output: 132/ for test: gen9_exec_parse
Done.