[58.481217] Initializing watchdogs
[58.481268]   /dev/watchdog0
[58.494214] [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.498130] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[58.500308] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[58.503706] [001/130] (960s left) syncobj_wait (wait-any-complex)
[58.632225] Starting subtest: wait-any-complex
[58.692048] Subtest wait-any-complex: SUCCESS (0.061s)
[58.764147] [002/130] (960s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-indfb-plflip-blt)
[58.880473] Starting subtest: fbcpsr-2p-primscrn-indfb-plflip-blt
[58.884604] Subtest fbcpsr-2p-primscrn-indfb-plflip-blt: SKIP (0.000s)
[58.994145] [003/130] (960s left) syncobj_wait (multi-wait-all-for-submit-submitted)
[59.059444] Starting subtest: multi-wait-all-for-submit-submitted
[59.168632] Subtest multi-wait-all-for-submit-submitted: SUCCESS (0.106s)
[59.233091] [004/130] (959s left) kms_pm_dc (dc5-dpms)
[60.333857] Starting subtest: dc5-dpms
[62.361729] Subtest dc5-dpms: SUCCESS (2.026s)
[62.429187] [005/130] (956s left) gem_userptr_blits (map-fixed-invalidate-overlap-busy)
[62.497966] Starting subtest: map-fixed-invalidate-overlap-busy
[62.502801] Subtest map-fixed-invalidate-overlap-busy: SKIP (0.000s)
[62.623367] [006/130] (956s left) gem_vm_create (isolation)
[62.682825] Starting subtest: isolation
[62.691181] Subtest isolation: SUCCESS (0.008s)
[62.835207] [007/130] (956s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[62.938623] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu
[67.229773] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SUCCESS (4.293s)
[67.335008] [008/130] (951s left) kms_async_flips (alternate-sync-async-flip)
[67.429894] Starting subtest: alternate-sync-async-flip
[67.802304] Starting dynamic subtest: pipe-A-eDP-1
[70.558102] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.754s)
[70.939566] Starting dynamic subtest: pipe-B-eDP-1
[73.691354] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.757s)
[74.056999] Starting dynamic subtest: pipe-C-eDP-1
[76.816206] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.767s)
[77.176230] Starting dynamic subtest: pipe-D-eDP-1
[79.948040] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.778s)
[79.950053] Subtest alternate-sync-async-flip: SUCCESS (12.513s)
[81.106277] [009/130] (938s left) i915_hangman (gt-engine-hang)
[81.171398] Starting subtest: gt-engine-hang
[81.173277] Starting dynamic subtest: rcs0
[82.892075] Dynamic subtest rcs0: SUCCESS (1.720s)
[82.902296] Starting dynamic subtest: bcs0
[84.875066] Dynamic subtest bcs0: SUCCESS (1.982s)
[84.884590] Starting dynamic subtest: vcs0
[86.922774] Dynamic subtest vcs0: SUCCESS (2.046s)
[86.932142] Starting dynamic subtest: vcs1
[88.905059] Dynamic subtest vcs1: SUCCESS (1.982s)
[88.914526] Starting dynamic subtest: vecs0
[90.889546] Dynamic subtest vecs0: SUCCESS (1.982s)
[90.898832] Starting dynamic subtest: ccs0
[92.873072] Dynamic subtest ccs0: SUCCESS (1.983s)
[92.875716] Subtest gt-engine-hang: SUCCESS (11.700s)
[93.004031] [010/130] (926s left) kms_psr2_sf (fbc-pr-overlay-plane-update-continuous-sf)
[98.074822] Starting subtest: fbc-pr-overlay-plane-update-continuous-sf
[98.079595] Subtest fbc-pr-overlay-plane-update-continuous-sf: SKIP (0.002s)
[98.904183] [011/130] (920s left) kms_fbcon_fbt (psr-suspend)
[98.962690] Starting subtest: psr-suspend
[146.032492] Subtest psr-suspend: SUCCESS (17.865s)
[146.113790] [012/130] (902s left) gem_exec_whisper (basic-fds-priority)
[146.184555] Starting subtest: basic-fds-priority
[170.304984] Subtest basic-fds-priority: SUCCESS (24.084s)
[170.483683] [013/130] (878s left) gem_softpin (allocator-basic)
[170.539201] Starting subtest: allocator-basic
[170.608858] Subtest allocator-basic: SUCCESS (0.068s)
[170.737496] [014/130] (877s left) gem_ctx_param (invalid-set-ringsize)
[170.796590] Starting subtest: invalid-set-ringsize
[170.798846] Subtest invalid-set-ringsize: SUCCESS (0.000s)
[170.865050] [015/130] (877s left) kms_psr2_su (page_flip-p010)
[170.931924] Subtest page_flip-P010: SKIP (0.000s)
[170.997535] [016/130] (877s left) fbdev (info)
[171.032530] Starting subtest: info
[171.034836] Subtest info: SUCCESS (0.000s)
[171.086821] [017/130] (877s left) kms_cursor_crc (cursor-random-max-size)
[171.364565] Starting subtest: cursor-random-max-size
[171.370698] Subtest cursor-random-max-size: SKIP (0.000s)
[171.489000] [018/130] (877s left) kms_big_fb (yf-tiled-16bpp-rotate-180)
[171.593605] Starting subtest: yf-tiled-16bpp-rotate-180
[171.597425] Subtest yf-tiled-16bpp-rotate-180: SKIP (0.000s)
[171.706411] [019/130] (877s left) syncobj_timeline (multi-wait-for-submit-available-submitted-signaled)
[171.769822] Starting subtest: multi-wait-for-submit-available-submitted-signaled
[171.771457] Subtest multi-wait-for-submit-available-submitted-signaled: SUCCESS (0.001s)
[171.878045] [020/130] (877s left) kms_addfb_basic (invalid-get-prop)
[171.930080] Starting subtest: invalid-get-prop
[171.931919] Subtest invalid-get-prop: SUCCESS (0.000s)
[172.085633] [021/130] (876s left) gem_fenced_exec_thrash (no-spare-fences)
[172.138617] Subtest no-spare-fences: SKIP (0.000s)
[172.219401] [022/130] (876s left) gem_ctx_bad_destroy (invalid-ctx)
[172.283697] Starting subtest: invalid-ctx
[172.285906] Subtest invalid-ctx: SUCCESS (0.000s)
[172.348795] [023/130] (876s left) gem_render_copy (linear)
[172.407295] Starting subtest: linear
[172.409118] Starting dynamic subtest: smem
[172.449643] Dynamic subtest smem: SUCCESS (0.042s)
[172.451970] Subtest linear: SUCCESS (0.043s)
[172.625578] [024/130] (876s left) syncobj_basic (bad-fd-to-handle)
[172.687995] Starting subtest: bad-fd-to-handle
[172.689864] Subtest bad-fd-to-handle: SUCCESS (0.000s)
[172.773406] [025/130] (876s left) kms_frontbuffer_tracking (fbc-indfb-scaledprimary)
[172.886050] Starting subtest: fbc-indfb-scaledprimary
[176.861380] Subtest fbc-indfb-scaledprimary: SUCCESS (3.981s)
[177.004326] [026/130] (872s left) kms_psr (pr-cursor-blt)
[177.105089] Starting subtest: pr-cursor-blt
[177.109607] Subtest pr-cursor-blt: SKIP (0.000s)
[177.168588] [027/130] (871s left) kms_flip (2x-flip-vs-panning-interruptible)
[177.273848] Starting subtest: 2x-flip-vs-panning-interruptible
[177.285947] Subtest 2x-flip-vs-panning-interruptible: SKIP (0.010s)
[177.354583] [028/130] (871s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[177.460163] Starting subtest: addfb25-y-tiled-legacy
[177.462490] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[177.559518] [029/130] (871s left) gem_exec_store (dword)
[177.620213] Starting subtest: dword
[177.622429] Starting dynamic subtest: rcs0
[177.716129] Dynamic subtest rcs0: SUCCESS (0.097s)
[177.727569] Starting dynamic subtest: bcs0
[177.756877] Dynamic subtest bcs0: SUCCESS (0.040s)
[177.765723] Starting dynamic subtest: vcs0
[177.799441] Dynamic subtest vcs0: SUCCESS (0.041s)
[177.808675] Starting dynamic subtest: vcs1
[177.840581] Dynamic subtest vcs1: SUCCESS (0.040s)
[177.849017] Starting dynamic subtest: vecs0
[177.880501] Dynamic subtest vecs0: SUCCESS (0.039s)
[177.890827] Starting dynamic subtest: ccs0
[177.919833] Dynamic subtest ccs0: SUCCESS (0.039s)
[177.922020] Subtest dword: SUCCESS (0.302s)
[178.100633] [030/130] (871s left) kms_psr (pr-sprite-mmap-cpu)
[178.202125] Starting subtest: pr-sprite-mmap-cpu
[178.206790] Subtest pr-sprite-mmap-cpu: SKIP (0.000s)
[178.268808] [031/130] (870s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-upscaling)
[178.360004] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-upscaling
[178.362298] Starting dynamic subtest: pipe-A-default-mode
[181.033872] Dynamic subtest pipe-A-default-mode: SUCCESS (2.675s)
[181.036192] Subtest flip-64bpp-xtile-to-16bpp-xtile-upscaling: SUCCESS (2.677s)
[181.900665] [032/130] (867s left) gem_exec_fence (invalid-timeline-fence-array)
[182.483998] Starting subtest: invalid-timeline-fence-array
[182.490353] Subtest invalid-timeline-fence-array: SUCCESS (0.005s)
[184.125610] [FACT gem_exec_fence (invalid-timeline-fence-array)] new: kernel.kmod_is_loaded.vgem: true
[184.130129] [033/130] (865s left) kms_frontbuffer_tracking (fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu)
[184.231099] Starting subtest: fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu
[187.536464] Subtest fbc-1p-primscrn-pri-shrfb-draw-mmap-cpu: SUCCESS (3.310s)
[187.680058] [034/130] (861s left) perf_pmu (multi-client)
[187.719324] Starting subtest: multi-client
[187.721633] Starting dynamic subtest: rcs0
[188.808269] Dynamic subtest rcs0: SUCCESS (1.087s)
[188.819122] Starting dynamic subtest: bcs0
[189.856154] Dynamic subtest bcs0: SUCCESS (1.047s)
[189.867051] Starting dynamic subtest: vcs0
[190.906562] Dynamic subtest vcs0: SUCCESS (1.049s)
[190.917203] Starting dynamic subtest: vcs1
[192.063990] Dynamic subtest vcs1: SUCCESS (1.156s)
[192.074277] Starting dynamic subtest: vecs0
[194.116647] Dynamic subtest vecs0: SUCCESS (2.051s)
[194.126663] Starting dynamic subtest: ccs0
[196.103509] Dynamic subtest ccs0: SUCCESS (1.986s)
[196.106388] Subtest multi-client: SUCCESS (8.383s)
[196.213950] [035/130] (853s left) gem_exec_gttfill (basic)
[196.276335] Starting subtest: basic
[201.546858] Subtest basic: SUCCESS (5.268s)
[201.728811] [036/130] (847s left) kms_vblank (crtc-id)
[201.865616] Starting subtest: crtc-id
[201.868003] Starting dynamic subtest: pipe-A-eDP-1
[202.309735] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.440s)
[202.326207] Starting dynamic subtest: pipe-D-eDP-1
[203.456031] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.147s)
[203.458404] Subtest crtc-id: SUCCESS (1.590s)
[204.280216] [037/130] (845s left) kms_ccs (bad-pixel-format-4-tiled-dg2-mc-ccs)
[204.397664] Starting subtest: bad-pixel-format-4-tiled-dg2-mc-ccs
[204.399993] Starting dynamic subtest: pipe-A-eDP-1
[204.422833] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[204.431584] Starting dynamic subtest: pipe-B-eDP-1
[204.453431] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[204.461577] Starting dynamic subtest: pipe-C-eDP-1
[204.483461] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[204.491343] Starting dynamic subtest: pipe-D-eDP-1
[204.513523] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[204.518033] Subtest bad-pixel-format-4-tiled-dg2-mc-ccs: SKIP (0.004s)
[206.536961] [038/130] (842s left) prime_udl
[206.612098] [039/130] (842s left) kms_cursor_crc (cursor-suspend)
[206.736785] Starting subtest: cursor-suspend
[206.739077] Starting dynamic subtest: pipe-A-eDP-1
[239.328048] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.102s)
[239.338007] Starting dynamic subtest: pipe-D-eDP-1
[272.311696] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.571s)
[272.314060] Subtest cursor-suspend: SUCCESS (6.675s)
[273.093983] [040/130] (835s left) vgem_basic (bad-fence)
[273.141721] Starting subtest: bad-fence
[273.143639] Subtest bad-fence: SUCCESS (0.000s)
[273.195474] [041/130] (835s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-180)
[273.302750] Starting subtest: linear-max-hw-stride-32bpp-rotate-180
[274.426845] Subtest linear-max-hw-stride-32bpp-rotate-180: SUCCESS (1.121s)
[274.582877] [042/130] (833s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs)
[274.673217] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs
[274.675166] Starting dynamic subtest: pipe-A-eDP-1
[274.692743] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.001s)
[274.701109] Starting dynamic subtest: pipe-B-eDP-1
[274.717786] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[274.725681] Starting dynamic subtest: pipe-C-eDP-1
[274.741765] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[274.749372] Starting dynamic subtest: pipe-D-eDP-1
[274.765378] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[274.767255] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs: SUCCESS (0.006s)
[276.855844] [043/130] (831s left) gem_exec_schedule (fifo)
[276.943838] Starting subtest: fifo
[276.946039] Starting dynamic subtest: rcs0
[277.033678] Dynamic subtest rcs0: SUCCESS (0.095s)
[277.048973] Starting dynamic subtest: vcs0
[277.118366] Dynamic subtest vcs0: SUCCESS (0.083s)
[277.131254] Starting dynamic subtest: vcs1
[277.190112] Dynamic subtest vcs1: SUCCESS (0.071s)
[277.203524] Starting dynamic subtest: vecs0
[277.257122] Dynamic subtest vecs0: SUCCESS (0.067s)
[277.265420] Starting dynamic subtest: ccs0
[277.333136] Dynamic subtest ccs0: SUCCESS (0.075s)
[277.335626] Subtest fifo: SUCCESS (0.395s)
[279.107111] [044/130] (829s left) kms_frontbuffer_tracking (fbcpsr-1p-offscren-pri-shrfb-draw-mmap-gtt)
[279.207801] Starting subtest: fbcpsr-1p-offscren-pri-shrfb-draw-mmap-gtt
[279.211842] Subtest fbcpsr-1p-offscren-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[279.325377] [045/130] (829s left) kms_big_fb (linear-16bpp-rotate-180)
[279.432541] Starting subtest: linear-16bpp-rotate-180
[280.870048] Subtest linear-16bpp-rotate-180: SUCCESS (1.435s)
[281.069338] [046/130] (827s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-move)
[281.177076] Starting subtest: fbc-1p-primscrn-spr-indfb-move
[284.465542] Subtest fbc-1p-primscrn-spr-indfb-move: SUCCESS (3.288s)
[284.575120] [047/130] (824s left) kms_joiner (basic-force-ultra-joiner)
[284.677312] Starting subtest: basic-force-ultra-joiner
[284.681825] Subtest basic-force-ultra-joiner: SKIP (0.000s)
[284.737250] [048/130] (824s left) gem_mmap_gtt (cpuset-medium-copy)
[284.799314] Subtest cpuset-medium-copy: SKIP (0.000s)
[284.849109] [049/130] (823s left) perf (gen12-unprivileged-single-ctx-counters)
[284.977536] Starting subtest: gen12-unprivileged-single-ctx-counters
[284.979498] Starting dynamic subtest: rcs0
[285.306626] Dynamic subtest rcs0: SUCCESS (0.330s)
[285.308849] Subtest gen12-unprivileged-single-ctx-counters: SUCCESS (0.331s)
[285.349431] [050/130] (823s left) kms_chamelium_hpd (dp-hpd-enable-disable-mode)
[285.772136] Subtest dp-hpd-enable-disable-mode: SKIP (0.000s)
[286.599423] [051/130] (822s left) kms_big_fb (4-tiled-32bpp-rotate-0)
[286.707728] Starting subtest: 4-tiled-32bpp-rotate-0
[288.419896] Subtest 4-tiled-32bpp-rotate-0: SUCCESS (1.710s)
[288.704238] [052/130] (820s left) gem_partial_pwrite_pread (reads-snoop)
[288.783390] Subtest reads-snoop: SKIP (0.000s)
[288.858715] [053/130] (820s left) kms_plane_scaling (planes-downscale-factor-0-25-unity-scaling)
[288.966706] Starting subtest: planes-downscale-factor-0-25-unity-scaling
[288.968950] Starting dynamic subtest: pipe-A
[288.983906] Dynamic subtest pipe-A: SKIP (0.011s)
[288.993132] Starting dynamic subtest: pipe-B
[289.005217] Dynamic subtest pipe-B: SKIP (0.021s)
[289.013925] Starting dynamic subtest: pipe-C
[289.026218] Dynamic subtest pipe-C: SKIP (0.020s)
[289.034909] Starting dynamic subtest: pipe-D
[289.046540] Dynamic subtest pipe-D: SKIP (0.020s)
[289.050409] Subtest planes-downscale-factor-0-25-unity-scaling: SKIP (0.073s)
[289.139688] [054/130] (819s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip)
[289.241891] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip
[290.043620] Subtest x-tiled-max-hw-stride-32bpp-rotate-180-hflip-async-flip: SUCCESS (0.803s)
[290.265799] [055/130] (818s left) gem_blits (basic)
[290.338419] Starting subtest: basic
[291.567888] Subtest basic: SUCCESS (1.228s)
[291.710849] [056/130] (817s left) syncobj_wait (wait-any-interrupted)
[291.774398] Starting subtest: wait-any-interrupted
[291.873789] Subtest wait-any-interrupted: SUCCESS (0.101s)
[291.954896] [057/130] (817s left) syncobj_timeline (wait-any-interrupted)
[292.016408] Starting subtest: wait-any-interrupted
[292.119705] Subtest wait-any-interrupted: SUCCESS (0.101s)
[292.191783] [058/130] (816s left) gem_ppgtt (shrink-vs-evict-any)
[292.255752] Starting subtest: shrink-vs-evict-any
[297.970094] Subtest shrink-vs-evict-any: SUCCESS (5.707s)
[298.081863] [059/130] (811s left) kms_psr (psr-primary-page-flip)
[298.197438] Starting subtest: psr-primary-page-flip
[298.199639] Starting dynamic subtest: eDP-1
[299.933026] Dynamic subtest eDP-1: SUCCESS (1.733s)
[299.935280] Subtest psr-primary-page-flip: SUCCESS (1.734s)
[300.780256] [060/130] (808s left) kms_psr (fbc-psr-cursor-render)
[300.881844] Starting subtest: fbc-psr-cursor-render
[300.883828] Starting dynamic subtest: eDP-1
[300.888055] Dynamic subtest eDP-1: SKIP (0.000s)
[300.892246] Subtest fbc-psr-cursor-render: SKIP (0.001s)
[300.947758] [061/130] (808s left) gem_exec_schedule (preempt-user)
[301.024727] Starting subtest: preempt-user
[301.027056] Starting dynamic subtest: rcs0
[301.039087] Dynamic subtest rcs0: SUCCESS (0.020s)
[301.048897] Starting dynamic subtest: bcs0
[301.054974] Dynamic subtest bcs0: SUCCESS (0.015s)
[301.063760] Starting dynamic subtest: vcs0
[301.072434] Dynamic subtest vcs0: SUCCESS (0.017s)
[301.081478] Starting dynamic subtest: vcs1
[301.090842] Dynamic subtest vcs1: SUCCESS (0.018s)
[301.099876] Starting dynamic subtest: vecs0
[301.108139] Dynamic subtest vecs0: SUCCESS (0.017s)
[301.117138] Starting dynamic subtest: ccs0
[301.126165] Dynamic subtest ccs0: SUCCESS (0.017s)
[301.128520] Subtest preempt-user: SUCCESS (0.108s)
[303.080425] [062/130] (806s left) gem_ctx_shared (single-timeline)
[303.146001] Starting subtest: single-timeline
[303.166749] Subtest single-timeline: SUCCESS (0.014s)
[303.394382] [063/130] (805s left) kms_psr (fbc-pr-cursor-blt)
[303.486785] Starting subtest: fbc-pr-cursor-blt
[303.491219] Subtest fbc-pr-cursor-blt: SKIP (0.000s)
[303.554827] [064/130] (805s left) kms_vblank (query-busy-hang)
[303.645719] Starting subtest: query-busy-hang
[303.648021] Starting dynamic subtest: pipe-A-eDP-1
[329.752925] Dynamic subtest pipe-A-eDP-1: SUCCESS (26.091s)
[329.768292] Starting dynamic subtest: pipe-D-eDP-1
[344.708836] Dynamic subtest pipe-D-eDP-1: SUCCESS (14.946s)
[344.711315] Subtest query-busy-hang: SUCCESS (41.041s)
[345.549491] [065/130] (763s left) gem_exec_fence (syncobj-timeline-export)
[346.124429] Starting subtest: syncobj-timeline-export
[346.129994] Subtest syncobj-timeline-export: SUCCESS (0.006s)
[348.079954] [066/130] (761s left) kms_cursor_legacy (single-bo)
[348.207618] Starting subtest: single-bo
[348.209906] Starting dynamic subtest: pipe-A
[353.597607] Dynamic subtest pipe-A: SUCCESS (5.382s)
[353.608625] Starting dynamic subtest: pipe-B
[358.983738] Dynamic subtest pipe-B: SUCCESS (5.381s)
[358.995278] Starting dynamic subtest: pipe-C
[364.370563] Dynamic subtest pipe-C: SUCCESS (5.381s)
[364.381232] Starting dynamic subtest: pipe-D
[369.753626] Dynamic subtest pipe-D: SUCCESS (5.382s)
[369.764945] Starting dynamic subtest: all-pipes
[375.141728] Dynamic subtest all-pipes: SUCCESS (5.389s)
[375.144231] Subtest single-bo: SUCCESS (26.927s)
[375.266960] [067/130] (734s left) api_intel_bb (render-ccs)
[375.325521] Starting subtest: render-ccs
[375.880720] Subtest render-ccs: SUCCESS (0.557s)
[375.991730] [068/130] (733s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs)
[376.078792] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs
[376.081169] Starting dynamic subtest: pipe-A-eDP-1
[376.943579] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.853s)
[376.954815] Starting dynamic subtest: pipe-B-eDP-1
[378.476365] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.532s)
[378.485997] Starting dynamic subtest: pipe-C-eDP-1
[379.979834] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.503s)
[379.990280] Starting dynamic subtest: pipe-D-eDP-1
[381.496634] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.517s)
[381.499050] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs: SUCCESS (5.409s)
[382.672177] [069/130] (726s left) api_intel_bb (blit-noreloc-purge-cache)
[382.722146] Starting subtest: blit-noreloc-purge-cache
[382.730757] Subtest blit-noreloc-purge-cache: SUCCESS (0.012s)
[382.818679] [070/130] (726s left) kms_frontbuffer_tracking (psr-rgb565-draw-pwrite)
[382.924257] Starting subtest: psr-rgb565-draw-pwrite
[387.814175] Subtest psr-rgb565-draw-pwrite: SUCCESS (4.892s)
[387.935642] [071/130] (721s left) kms_chamelium_audio (hdmi-audio)
[388.322651] Subtest hdmi-audio: SKIP (0.000s)
[389.122983] [072/130] (720s left) gem_softpin (overlap)
[389.191315] Starting subtest: overlap
[389.932844] Subtest overlap: SUCCESS (0.743s)
[390.061985] [073/130] (719s left) gem_workarounds (suspend-resume-fd)
[390.128802] Starting subtest: suspend-resume-fd
[405.923947] Subtest suspend-resume-fd: SUCCESS (1.182s)
[406.059094] [074/130] (718s left) gen9_exec_parse (bb-chained)
[406.128636] Subtest bb-chained: SKIP (0.000s)
[406.204109] [075/130] (718s left) gem_exec_balancer (nohangcheck)
[406.454065] Starting subtest: nohangcheck
[407.210938] Subtest nohangcheck: SUCCESS (0.753s)
[407.354778] [076/130] (717s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[407.470624] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[407.475612] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[407.578072] [077/130] (716s left) gem_exec_flush (basic-uc-set-default)
[407.641515] Starting subtest: basic-uc-set-default
[413.139151] Subtest basic-uc-set-default: SUCCESS (5.476s)
[413.325817] [078/130] (711s left) gem_ctx_persistence (legacy-engines-cleanup)
[413.393771] Starting subtest: legacy-engines-cleanup
[413.396647] Starting dynamic subtest: render
[413.480243] Dynamic subtest render: SUCCESS (0.085s)
[413.491126] Starting dynamic subtest: bsd1
[413.548496] Dynamic subtest bsd1: SUCCESS (0.066s)
[413.559794] Starting dynamic subtest: bsd2
[413.627293] Dynamic subtest bsd2: SUCCESS (0.076s)
[413.638861] Starting dynamic subtest: blt
[413.696053] Dynamic subtest blt: SUCCESS (0.066s)
[413.708786] Starting dynamic subtest: vebox
[413.755076] Dynamic subtest vebox: SUCCESS (0.057s)
[413.757946] Subtest legacy-engines-cleanup: SUCCESS (0.361s)
[413.830825] [079/130] (710s left) kms_dither (fb-8bpc-vs-panel-6bpc)
[413.939490] Starting subtest: fb-8bpc-vs-panel-6bpc
[413.942427] Starting dynamic subtest: pipe-A-eDP-1
[415.293028] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.349s)
[415.295783] Subtest fb-8bpc-vs-panel-6bpc: SUCCESS (1.351s)
[416.159019] [080/130] (708s left) kms_frontbuffer_tracking (fbc-1p-offscren-pri-shrfb-draw-mmap-gtt)
[416.255944] Starting subtest: fbc-1p-offscren-pri-shrfb-draw-mmap-gtt
[416.260681] Subtest fbc-1p-offscren-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[416.351555] [081/130] (708s left) kms_frontbuffer_tracking (psr-farfromfence-mmap-gtt)
[416.452763] Starting subtest: psr-farfromfence-mmap-gtt
[416.457518] Subtest psr-farfromfence-mmap-gtt: SKIP (0.000s)
[416.552096] [082/130] (708s left) kms_big_fb (y-tiled-16bpp-rotate-180)
[416.664744] Starting subtest: y-tiled-16bpp-rotate-180
[416.669669] Subtest y-tiled-16bpp-rotate-180: SKIP (0.000s)
[416.781771] [083/130] (707s left) kms_pm_lpsp (kms-lpsp)
[417.891665] Starting subtest: kms-lpsp
[417.894193] Starting dynamic subtest: pipe-A-eDP-1
[418.050645] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.160s)
[418.337484] Subtest kms-lpsp: SUCCESS (0.444s)
[419.189933] [084/130] (705s left) kms_cursor_legacy (short-flip-before-cursor-atomic-transitions)
[419.316465] Starting subtest: short-flip-before-cursor-atomic-transitions
[420.283545] Subtest short-flip-before-cursor-atomic-transitions: SUCCESS (0.966s)
[421.114732] [085/130] (703s left) dmabuf_sync_file (export-multiwait)
[421.164815] Starting subtest: export-multiwait
[421.167657] Subtest export-multiwait: SUCCESS (0.001s)
[421.216335] [086/130] (703s left) gem_flink_basic (basic)
[421.279596] Starting subtest: basic
[421.282638] Subtest basic: SUCCESS (0.000s)
[421.388093] [087/130] (703s left) kms_lease (lease-get)
[421.498561] Starting subtest: lease-get
[421.501230] Starting dynamic subtest: pipe-A-eDP-1
[421.504189] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.002s)
[421.513415] Starting dynamic subtest: pipe-B-eDP-1
[421.515753] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[421.524114] Starting dynamic subtest: pipe-C-eDP-1
[421.526437] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.001s)
[421.534729] Starting dynamic subtest: pipe-D-eDP-1
[421.537053] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.001s)
[421.539268] Subtest lease-get: SUCCESS (0.008s)
[421.599521] [088/130] (703s left) gem_exec_params (batch-first)
[421.653479] Starting subtest: batch-first
[421.661495] Subtest batch-first: SUCCESS (0.008s)
[421.811655] [089/130] (703s left) gem_eio (wait-wedge-immediate)
[422.043485] Starting subtest: wait-wedge-immediate
[423.654417] Subtest wait-wedge-immediate: SUCCESS (1.611s)
[423.765069] [090/130] (701s left) kms_cursor_crc (cursor-offscreen-32x10)
[423.911768] Starting subtest: cursor-offscreen-32x10
[423.947731] Subtest cursor-offscreen-32x10: SKIP (0.031s)
[424.225801] [091/130] (700s left) kms_vblank (wait-idle-hang)
[424.325376] Starting subtest: wait-idle-hang
[424.328012] Starting dynamic subtest: pipe-A-eDP-1
[426.262486] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.932s)
[426.278274] Starting dynamic subtest: pipe-D-eDP-1
[428.766571] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.501s)
[428.769510] Subtest wait-idle-hang: SUCCESS (4.437s)
[429.578244] [092/130] (695s left) kms_flip_scaled_crc (flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling)
[429.684346] Starting subtest: flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling
[429.686756] Starting dynamic subtest: pipe-A-default-mode
[429.993889] Dynamic subtest pipe-A-default-mode: SKIP (0.305s)
[429.999278] Subtest flip-32bpp-4tile-to-32bpp-4tiledg2rcccs-upscaling: SKIP (0.307s)
[430.800947] [093/130] (694s left) debugfs_test (read_all_entries_display_off)
[430.899081] Starting subtest: read_all_entries_display_off
[431.969656] Subtest read_all_entries_display_off: SUCCESS (1.068s)
[432.280588] [094/130] (692s left) gem_unref_active_buffers
[432.467843] [095/130] (692s left) kms_big_fb (y-tiled-addfb-size-overflow)
[432.574435] Starting subtest: y-tiled-addfb-size-overflow
[432.579284] Subtest y-tiled-addfb-size-overflow: SKIP (0.000s)
[432.670176] [096/130] (692s left) kms_ccs (crc-primary-suspend-4-tiled-mtl-rc-ccs)
[432.766466] Starting subtest: crc-primary-suspend-4-tiled-mtl-rc-ccs
[432.769253] Starting dynamic subtest: pipe-A-eDP-1
[449.386692] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.644s)
[449.397803] Starting dynamic subtest: pipe-B-eDP-1
[467.028592] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.294s)
[467.039281] Starting dynamic subtest: pipe-C-eDP-1
[483.998566] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.296s)
[484.008201] Starting dynamic subtest: pipe-D-eDP-1
[500.985946] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.190s)
[500.988494] Subtest crc-primary-suspend-4-tiled-mtl-rc-ccs: SUCCESS (8.428s)
[502.200735] [097/130] (682s left) kms_flip (plain-flip-ts-check-interruptible)
[502.312491] Starting subtest: plain-flip-ts-check-interruptible
[502.315254] Starting dynamic subtest: A-eDP1
[511.192772] Dynamic subtest A-eDP1: SUCCESS (8.848s)
[511.202296] Starting dynamic subtest: B-eDP1
[520.061220] Dynamic subtest B-eDP1: SUCCESS (8.840s)
[520.072303] Starting dynamic subtest: C-eDP1
[528.874494] Dynamic subtest C-eDP1: SUCCESS (8.819s)
[528.885339] Starting dynamic subtest: D-eDP1
[537.707520] Dynamic subtest D-eDP1: SUCCESS (8.833s)
[537.710052] Subtest plain-flip-ts-check-interruptible: SUCCESS (35.350s)
[538.868716] [098/130] (646s left) kms_chamelium_frames (dp-crc-multiple)
[539.252619] Subtest dp-crc-multiple: SKIP (0.000s)
[540.077181] [099/130] (645s left) gem_userptr_blits (huge-split)
[540.162528] Starting subtest: huge-split
[540.169701] Subtest huge-split: SUCCESS (0.008s)
[540.305205] [100/130] (644s left) kms_getfb (getfb-handle-valid)
[540.371996] Starting subtest: getfb-handle-valid
[540.375059] Subtest getfb-handle-valid: SUCCESS (0.000s)
[540.473751] [101/130] (644s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-indfb-draw-render)
[540.588437] Starting subtest: psr-2p-primscrn-pri-indfb-draw-render
[540.593513] Subtest psr-2p-primscrn-pri-indfb-draw-render: SKIP (0.000s)
[540.687149] [102/130] (644s left) kms_prime (basic-crc-hybrid)
[542.923757] Subtest basic-crc-hybrid: SKIP (0.000s)
[542.998577] [FACT kms_prime (basic-crc-hybrid)] new: kernel.kmod_is_loaded.amdgpu: true
[542.999263] [FACT kms_prime (basic-crc-hybrid)] new: kernel.kmod_is_loaded.xe: true
[543.002981] [103/130] (642s left) prime_vgem (sync)
[543.088334] Starting subtest: sync
[543.090376] Starting dynamic subtest: rcs0
[543.133573] Dynamic subtest rcs0: SUCCESS (0.047s)
[543.143182] Starting dynamic subtest: bcs0
[543.208655] Dynamic subtest bcs0: SUCCESS (0.075s)
[543.217563] Starting dynamic subtest: vcs0
[543.257086] Dynamic subtest vcs0: SUCCESS (0.048s)
[543.266143] Starting dynamic subtest: vcs1
[543.305253] Dynamic subtest vcs1: SUCCESS (0.047s)
[543.314529] Starting dynamic subtest: vecs0
[543.353182] Dynamic subtest vecs0: SUCCESS (0.047s)
[543.362767] Starting dynamic subtest: ccs0
[543.403880] Dynamic subtest ccs0: SUCCESS (0.050s)
[543.406332] Subtest sync: SUCCESS (0.318s)
[543.546729] [104/130] (641s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted)
[543.611714] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted
[543.614475] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s)
[543.693009] [105/130] (641s left) kms_color (ctm-blue-to-red)
[543.790943] Starting subtest: ctm-blue-to-red
[543.793596] Starting dynamic subtest: pipe-A-eDP-1
[544.488535] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.695s)
[544.500865] Starting dynamic subtest: pipe-B-eDP-1
[545.873628] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.384s)
[545.884948] Starting dynamic subtest: pipe-C-eDP-1
[547.152712] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.277s)
[547.163455] Starting dynamic subtest: pipe-D-eDP-1
[548.475709] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.325s)
[548.478398] Subtest ctm-blue-to-red: SUCCESS (4.684s)
[549.306692] [106/130] (636s left) kms_pipe_crc_basic (bad-source)
[549.410226] Starting subtest: bad-source
[549.412499] Subtest bad-source: SUCCESS (0.000s)
[549.481232] [107/130] (635s left) kms_rotation_crc (bad-pixel-format)
[549.578411] Starting subtest: bad-pixel-format
[549.583550] Subtest bad-pixel-format: SKIP (0.001s)
[549.650013] [108/130] (635s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[549.710335] Starting subtest: etime-multi-wait-for-submit-submitted
[549.812103] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.104s)
[549.883257] [109/130] (635s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-pwrite)
[549.985773] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-pwrite
[554.627032] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-pwrite: SUCCESS (4.645s)
[554.759205] [110/130] (630s left) syncobj_basic (create-signaled)
[554.813523] Starting subtest: create-signaled
[554.816516] Subtest create-signaled: SUCCESS (0.000s)
[554.910631] [111/130] (630s left) i915_pm_rps (fence-order)
[554.979592] Starting subtest: fence-order
[557.458331] Subtest fence-order: SUCCESS (2.475s)
[557.539815] [112/130] (628s left) sw_sync (sync_random_merge)
[557.577841] Starting subtest: sync_random_merge
[557.609288] Subtest sync_random_merge: SUCCESS (0.037s)
[557.668163] [113/130] (627s left) kms_plane_cursor (viewport)
[557.772236] Starting subtest: viewport
[557.777124] Starting dynamic subtest: pipe-A-eDP-1-size-64
[560.663534] Dynamic subtest pipe-A-eDP-1-size-64: SUCCESS (2.888s)
[560.721940] Starting dynamic subtest: pipe-A-eDP-1-size-128
[563.620295] Dynamic subtest pipe-A-eDP-1-size-128: SUCCESS (2.903s)
[563.679529] Starting dynamic subtest: pipe-A-eDP-1-size-256
[566.587744] Dynamic subtest pipe-A-eDP-1-size-256: SUCCESS (2.915s)
[566.936843] Starting dynamic subtest: pipe-B-eDP-1-size-64
[570.567360] Dynamic subtest pipe-B-eDP-1-size-64: SUCCESS (3.641s)
[570.626499] Starting dynamic subtest: pipe-B-eDP-1-size-128
[573.468281] Dynamic subtest pipe-B-eDP-1-size-128: SUCCESS (2.848s)
[573.528441] Starting dynamic subtest: pipe-B-eDP-1-size-256
[576.412935] Dynamic subtest pipe-B-eDP-1-size-256: SUCCESS (2.892s)
[576.750978] Starting dynamic subtest: pipe-C-eDP-1-size-64
[579.855733] Dynamic subtest pipe-C-eDP-1-size-64: SUCCESS (3.113s)
[579.892426] Starting dynamic subtest: pipe-C-eDP-1-size-128
[582.378346] Dynamic subtest pipe-C-eDP-1-size-128: SUCCESS (2.491s)
[582.415909] Starting dynamic subtest: pipe-C-eDP-1-size-256
[584.868551] Dynamic subtest pipe-C-eDP-1-size-256: SUCCESS (2.458s)
[585.197491] Starting dynamic subtest: pipe-D-eDP-1-size-64
[588.361469] Dynamic subtest pipe-D-eDP-1-size-64: SUCCESS (3.174s)
[588.398814] Starting dynamic subtest: pipe-D-eDP-1-size-128
[590.784517] Dynamic subtest pipe-D-eDP-1-size-128: SUCCESS (2.391s)
[590.821075] Starting dynamic subtest: pipe-D-eDP-1-size-256
[593.284481] Dynamic subtest pipe-D-eDP-1-size-256: SUCCESS (2.468s)
[593.603252] Subtest viewport: SUCCESS (35.816s)
[594.471448] [114/130] (591s left) sw_sync (sync_multi_consumer)
[594.510323] Starting subtest: sync_multi_consumer
[595.342402] Subtest sync_multi_consumer: SUCCESS (0.833s)
[595.399534] [115/130] (590s left) gem_mmap_offset (clear-via-pagefault)
[595.466489] Starting subtest: clear-via-pagefault
[595.469115] Starting dynamic subtest: smem0
[654.909469] Dynamic subtest smem0: SUCCESS (59.439s)
[654.912242] Subtest clear-via-pagefault: SUCCESS (59.441s)
[655.264843] [116/130] (530s left) syncobj_timeline (invalid-signal-illegal-point)
[655.318236] Starting subtest: invalid-signal-illegal-point
[655.320838] Subtest invalid-signal-illegal-point: SUCCESS (0.000s)
[655.420458] [117/130] (530s left) gem_ctx_exec (basic-norecovery)
[655.483273] Starting subtest: basic-norecovery
[655.841469] Subtest basic-norecovery: SUCCESS (0.358s)
[655.978238] [118/130] (529s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-fullscreen)
[656.087390] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-fullscreen
[656.092408] Subtest fbcpsr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[656.170197] [119/130] (529s left) gem_lmem_swapping (parallel-random-verify-ccs)
[656.214834] Subtest parallel-random-verify-ccs: SKIP (0.000s)
[656.255370] [120/130] (529s left) kms_flip (flip-vs-expired-vblank-interruptible)
[656.353742] Starting subtest: flip-vs-expired-vblank-interruptible
[656.356446] Starting dynamic subtest: A-eDP1
[665.070978] Dynamic subtest A-eDP1: SUCCESS (8.713s)
[665.080433] Starting dynamic subtest: B-eDP1
[673.710031] Dynamic subtest B-eDP1: SUCCESS (8.635s)
[673.721830] Starting dynamic subtest: C-eDP1
[682.324610] Dynamic subtest C-eDP1: SUCCESS (8.612s)
[682.340022] Starting dynamic subtest: D-eDP1
[690.963406] Dynamic subtest D-eDP1: SUCCESS (8.633s)
[690.966369] Subtest flip-vs-expired-vblank-interruptible: SUCCESS (34.603s)
[692.122934] [121/130] (493s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-render)
[692.231588] Starting subtest: psr-1p-primscrn-pri-indfb-draw-render
[697.466247] Subtest psr-1p-primscrn-pri-indfb-draw-render: SUCCESS (5.238s)
[697.588176] [122/130] (488s left) kms_flip_scaled_crc (flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[697.693080] Starting subtest: flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[697.695433] Starting dynamic subtest: pipe-A-default-mode
[697.979593] Dynamic subtest pipe-A-default-mode: SKIP (0.282s)
[697.984847] Subtest flip-32bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.283s)
[698.809676] [123/130] (487s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-indfb-msflip-blt)
[698.923971] Starting subtest: fbcpsr-2p-scndscrn-indfb-msflip-blt
[698.929609] Subtest fbcpsr-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[699.034434] [124/130] (486s left) gem_render_copy (yf-tiled-ccs-to-x-tiled)
[699.087765] Starting subtest: yf-tiled-ccs-to-x-tiled
[699.093582] Subtest yf-tiled-ccs-to-x-tiled: SKIP (0.000s)
[699.284985] [125/130] (486s left) kms_frontbuffer_tracking (psr-1p-offscren-pri-shrfb-draw-mmap-cpu)
[699.399327] Starting subtest: psr-1p-offscren-pri-shrfb-draw-mmap-cpu
[703.941089] Subtest psr-1p-offscren-pri-shrfb-draw-mmap-cpu: SUCCESS (4.544s)
[704.061466] [126/130] (482s left) gem_workarounds (basic-read)
[704.138545] Starting subtest: basic-read
[704.149756] Subtest basic-read: SUCCESS (0.010s)
[704.268851] [127/130] (481s left) kms_psr_stress_test (invalidate-primary-flip-overlay)
[704.370572] Starting subtest: invalidate-primary-flip-overlay
[715.141440] Subtest invalidate-primary-flip-overlay: SUCCESS (10.770s)
[715.286813] [128/130] (470s left) kms_plane_multiple (tiling-yf)
[715.384951] Starting subtest: tiling-yf
[715.389065] Subtest tiling-yf: SKIP (0.000s)
[715.453567] [129/130] (470s left) syncobj_timeline (invalid-multi-wait-unsubmitted-submitted-signaled)
[715.505514] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[715.508014] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[715.591795] [130/130] (470s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-draw-blt)
[715.680088] Starting subtest: fbc-2p-primscrn-spr-indfb-draw-blt
[715.683583] Subtest fbc-2p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[715.789220] Closing watchdogs
Done.