[57.748347] Initializing watchdogs
[57.748395]   /dev/watchdog0
[57.763097] [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]
[57.767584] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[57.770075] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[57.773577] [001/134] (960s left) kms_cursor_edge_walk (256x256-left-edge)
[57.905095] Starting subtest: 256x256-left-edge
[57.907502] Starting dynamic subtest: pipe-A-eDP-1
[61.359504] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.452s)
[61.368160] Starting dynamic subtest: pipe-D-eDP-1
[64.484061] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.125s)
[64.486391] Subtest 256x256-left-edge: SUCCESS (6.579s)
[65.309366] [002/134] (952s left) kms_pipe_stress (stress-xrgb8888-ytiled)
[65.416062] Starting subtest: stress-xrgb8888-ytiled
[65.420422] Subtest stress-xrgb8888-ytiled: SKIP (0.000s)
[65.497559] [003/134] (952s left) kms_big_fb (4-tiled-64bpp-rotate-0)
[65.600859] Starting subtest: 4-tiled-64bpp-rotate-0
[67.356769] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.756s)
[67.690132] [004/134] (950s left) gem_exec_whisper (basic-queues-forked)
[67.776960] Starting subtest: basic-queues-forked
[91.123134] Subtest basic-queues-forked: SUCCESS (23.343s)
[91.331375] [005/134] (927s left) gem_render_copy (y-tiled-ccs-to-linear)
[91.401499] Starting subtest: y-tiled-ccs-to-linear
[91.406295] Subtest y-tiled-ccs-to-linear: SKIP (0.000s)
[91.608393] [006/134] (926s left) gem_flink_race (flink_name)
[91.647780] Starting subtest: flink_name
[97.049709] Subtest flink_name: SUCCESS (5.397s)
[97.202639] [007/134] (921s left) kms_ccs (crc-primary-basic-4-tiled-dg2-rc-ccs-cc)
[97.301744] Starting subtest: crc-primary-basic-4-tiled-dg2-rc-ccs-cc
[97.304031] Starting dynamic subtest: pipe-A-eDP-1
[97.326772] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[97.336970] Starting dynamic subtest: pipe-B-eDP-1
[97.358318] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[97.366075] Starting dynamic subtest: pipe-C-eDP-1
[97.387411] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[97.395065] Starting dynamic subtest: pipe-D-eDP-1
[97.418086] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[97.422233] Subtest crc-primary-basic-4-tiled-dg2-rc-ccs-cc: SKIP (0.004s)
[99.480486] [008/134] (919s left) gem_ringfill (engines-basic)
[104.921383] Starting subtest: engines-basic
[104.923960] Starting dynamic subtest: rcs0
[105.009086] Dynamic subtest rcs0: SUCCESS (0.089s)
[105.020814] Starting dynamic subtest: bcs0
[105.054078] Dynamic subtest bcs0: SUCCESS (0.044s)
[105.062579] Starting dynamic subtest: vcs0
[105.096539] Dynamic subtest vcs0: SUCCESS (0.042s)
[105.105684] Starting dynamic subtest: vcs1
[105.139017] Dynamic subtest vcs1: SUCCESS (0.042s)
[105.149816] Starting dynamic subtest: vecs0
[105.180993] Dynamic subtest vecs0: SUCCESS (0.041s)
[105.190379] Starting dynamic subtest: ccs0
[105.228372] Dynamic subtest ccs0: SUCCESS (0.046s)
[105.230926] Subtest engines-basic: SUCCESS (0.309s)
[105.328148] [FACT gem_ringfill (engines-basic)] new: kernel.kmod_is_loaded.vgem: true
[105.331340] [009/134] (913s left) kms_psr (pr-primary-render)
[105.438841] Starting subtest: pr-primary-render
[105.442940] Subtest pr-primary-render: SKIP (0.000s)
[105.543026] [010/134] (913s left) vgem_basic (bad-handle)
[105.587517] Starting subtest: bad-handle
[105.589619] Subtest bad-handle: SUCCESS (0.000s)
[105.663892] [011/134] (913s left) gem_exec_schedule (preemptive-hang)
[105.844767] Starting subtest: preemptive-hang
[105.847257] Starting dynamic subtest: rcs0
[115.011082] Dynamic subtest rcs0: SUCCESS (9.168s)
[115.020960] Starting dynamic subtest: bcs0
[124.031366] Dynamic subtest bcs0: SUCCESS (9.021s)
[124.041063] Starting dynamic subtest: vcs0
[133.052462] Dynamic subtest vcs0: SUCCESS (9.018s)
[133.062120] Starting dynamic subtest: vcs1
[142.011190] Dynamic subtest vcs1: SUCCESS (8.959s)
[142.021625] Starting dynamic subtest: vecs0
[151.096751] Dynamic subtest vecs0: SUCCESS (9.085s)
[151.106126] Starting dynamic subtest: ccs0
[160.062481] Dynamic subtest ccs0: SUCCESS (8.963s)
[160.064912] Subtest preemptive-hang: SUCCESS (54.217s)
[160.351473] [012/134] (858s left) gem_exec_schedule (deep)
[160.534366] Starting subtest: deep
[160.536494] Starting dynamic subtest: rcs0
[166.620584] Dynamic subtest rcs0: SKIP (6.083s)
[166.631069] Starting dynamic subtest: vcs0
[176.561864] Dynamic subtest vcs0: SUCCESS (9.943s)
[176.572384] Starting dynamic subtest: vcs1
[187.933666] Dynamic subtest vcs1: SUCCESS (11.370s)
[187.944628] Starting dynamic subtest: vecs0
[198.360139] Dynamic subtest vecs0: SUCCESS (10.426s)
[198.372737] Starting dynamic subtest: ccs0
[210.830734] Dynamic subtest ccs0: SUCCESS (12.469s)
[210.833447] Subtest deep: SUCCESS (50.293s)
[212.515984] [013/134] (806s left) kms_flip (dpms-vs-vblank-race)
[212.621325] Starting subtest: dpms-vs-vblank-race
[212.623591] Starting dynamic subtest: A-eDP1
[216.525196] Dynamic subtest A-eDP1: SUCCESS (3.903s)
[216.533807] Starting dynamic subtest: B-eDP1
[220.258532] Dynamic subtest B-eDP1: SUCCESS (3.731s)
[220.268516] Starting dynamic subtest: C-eDP1
[224.884911] Dynamic subtest C-eDP1: SUCCESS (4.627s)
[224.894541] Starting dynamic subtest: D-eDP1
[229.524471] Dynamic subtest D-eDP1: SUCCESS (4.639s)
[229.526786] Subtest dpms-vs-vblank-race: SUCCESS (16.905s)
[230.414505] [014/134] (788s left) kms_cursor_crc (cursor-rapid-movement-64x64)
[230.589955] Starting subtest: cursor-rapid-movement-64x64
[230.594731] Starting dynamic subtest: pipe-A-eDP-1
[231.149333] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.554s)
[231.177509] Starting dynamic subtest: pipe-D-eDP-1
[232.406063] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.234s)
[232.408365] Subtest cursor-rapid-movement-64x64: SUCCESS (1.814s)
[233.278844] [015/134] (785s left) gem_exec_flush (basic-wb-prw-default)
[233.353161] Starting subtest: basic-wb-prw-default
[238.813780] Subtest basic-wb-prw-default: SUCCESS (5.463s)
[239.023285] [016/134] (779s left) kms_vblank (ts-continuation-dpms-rpm)
[239.118959] Starting subtest: ts-continuation-dpms-rpm
[239.121288] Starting dynamic subtest: pipe-A-eDP-1
[241.643297] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.524s)
[241.655663] Starting dynamic subtest: pipe-D-eDP-1
[243.893768] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.247s)
[243.895759] Subtest ts-continuation-dpms-rpm: SUCCESS (4.775s)
[244.803634] [017/134] (774s left) gem_softpin (noreloc)
[244.871892] Starting subtest: noreloc
[250.289377] Subtest noreloc: SUCCESS (5.416s)
[250.460662] [018/134] (768s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-fullscreen)
[250.580516] Starting subtest: fbc-1p-primscrn-spr-indfb-fullscreen
[254.605997] Subtest fbc-1p-primscrn-spr-indfb-fullscreen: SUCCESS (4.028s)
[255.810925] [019/134] (763s left) kms_flip_scaled_crc (flip-64bpp-yftile-to-16bpp-yftile-downscaling)
[255.903479] Starting subtest: flip-64bpp-yftile-to-16bpp-yftile-downscaling
[255.905883] Starting dynamic subtest: pipe-A-default-mode
[256.199497] Dynamic subtest pipe-A-default-mode: SKIP (0.292s)
[256.204079] Subtest flip-64bpp-yftile-to-16bpp-yftile-downscaling: SKIP (0.293s)
[257.036054] [020/134] (762s left) perf_pmu (busy-start)
[257.073943] Starting subtest: busy-start
[257.076531] Starting dynamic subtest: rcs0
[259.625367] Dynamic subtest rcs0: SUCCESS (2.551s)
[259.635711] Starting dynamic subtest: bcs0
[262.173060] Dynamic subtest bcs0: SUCCESS (2.546s)
[262.184590] Starting dynamic subtest: vcs0
[265.940050] Dynamic subtest vcs0: SUCCESS (3.764s)
[265.951080] Starting dynamic subtest: vcs1
[269.908035] Dynamic subtest vcs1: SUCCESS (3.966s)
[269.919240] Starting dynamic subtest: vecs0
[273.939901] Dynamic subtest vecs0: SUCCESS (4.030s)
[273.950904] Starting dynamic subtest: ccs0
[276.486971] Dynamic subtest ccs0: SUCCESS (2.547s)
[276.489642] Subtest busy-start: SUCCESS (19.413s)
[276.615771] [021/134] (742s left) kms_color (ctm-0-50)
[276.714786] Starting subtest: ctm-0-50
[276.716949] Starting dynamic subtest: pipe-A-eDP-1
[280.138237] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.423s)
[280.150333] Starting dynamic subtest: pipe-B-eDP-1
[284.429313] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.292s)
[284.438163] Starting dynamic subtest: pipe-C-eDP-1
[288.476144] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.045s)
[288.484944] Starting dynamic subtest: pipe-D-eDP-1
[292.484491] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.008s)
[292.486830] Subtest ctm-0-50: SUCCESS (15.769s)
[293.331252] [022/134] (725s left) i915_query (query-topology-garbage-items)
[293.398978] Starting subtest: query-topology-garbage-items
[293.401370] Subtest query-topology-garbage-items: SUCCESS (0.000s)
[293.542605] [023/134] (725s left) gem_render_copy (y-tiled-ccs-to-y-tiled)
[293.609729] Starting subtest: y-tiled-ccs-to-y-tiled
[293.614079] Subtest y-tiled-ccs-to-y-tiled: SKIP (0.000s)
[293.815876] [024/134] (725s left) gem_exec_fence (submit-chain)
[294.005793] Starting subtest: submit-chain
[294.018894] Subtest submit-chain: SUCCESS (0.017s)
[295.997160] [025/134] (723s left) kms_big_fb (y-tiled-8bpp-rotate-0)
[296.107499] Starting subtest: y-tiled-8bpp-rotate-0
[296.111496] Subtest y-tiled-8bpp-rotate-0: SKIP (0.000s)
[296.242636] [026/134] (723s left) kms_properties (colorop-properties-atomic)
[296.344336] Starting subtest: colorop-properties-atomic
[296.346713] Starting dynamic subtest: pipe-A-eDP-1
[296.687157] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.343s)
[296.698052] Starting dynamic subtest: pipe-B-eDP-1
[297.770196] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.081s)
[297.779549] Starting dynamic subtest: pipe-C-eDP-1
[298.802810] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.031s)
[298.812062] Starting dynamic subtest: pipe-D-eDP-1
[299.835242] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.032s)
[299.837103] Subtest colorop-properties-atomic: SUCCESS (3.492s)
[300.664670] [027/134] (718s left) syncobj_timeline (etime-multi-wait-all-for-submit-submitted)
[300.728570] Starting subtest: etime-multi-wait-all-for-submit-submitted
[300.833062] Subtest etime-multi-wait-all-for-submit-submitted: SUCCESS (0.104s)
[300.936166] [028/134] (718s left) kms_big_fb (yf-tiled-8bpp-rotate-90)
[301.065386] Starting subtest: yf-tiled-8bpp-rotate-90
[301.069724] Subtest yf-tiled-8bpp-rotate-90: SKIP (0.000s)
[301.186782] [029/134] (718s left) kms_flip (bo-too-big)
[301.276039] Starting subtest: bo-too-big
[301.278302] Starting dynamic subtest: A-eDP1
[302.585316] Dynamic subtest A-eDP1: SUCCESS (1.308s)
[302.598505] Starting dynamic subtest: B-eDP1
[303.920274] Dynamic subtest B-eDP1: SUCCESS (1.332s)
[303.931602] Starting dynamic subtest: C-eDP1
[305.245685] Dynamic subtest C-eDP1: SUCCESS (1.325s)
[305.255905] Starting dynamic subtest: D-eDP1
[306.589456] Dynamic subtest D-eDP1: SUCCESS (1.343s)
[306.592033] Subtest bo-too-big: SUCCESS (5.316s)
[307.812037] [030/134] (711s left) gem_pxp (hw-rejects-pxp-context)
[307.938033] Starting subtest: hw-rejects-pxp-context
[307.943373] Subtest hw-rejects-pxp-context: SKIP (0.000s)
[308.068540] [031/134] (711s left) gem_mmap_wc (invalid-flags)
[308.124077] Subtest invalid-flags: SKIP (0.000s)
[308.182358] [032/134] (711s left) kms_content_protection (legacy)
[308.322859] Starting subtest: legacy
[308.327319] Subtest legacy: SKIP (0.000s)
[308.492288] [033/134] (711s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-shrfb-plflip-blt)
[308.595377] Starting subtest: fbcpsr-1p-primscrn-shrfb-plflip-blt
[316.118164] Subtest fbcpsr-1p-primscrn-shrfb-plflip-blt: SUCCESS (7.525s)
[316.288942] [034/134] (703s left) kms_flip (blocking-wf_vblank)
[316.389231] Starting subtest: blocking-wf_vblank
[316.391497] Starting dynamic subtest: A-eDP1
[325.273870] Dynamic subtest A-eDP1: SUCCESS (8.883s)
[325.286323] Starting dynamic subtest: B-eDP1
[334.211262] Dynamic subtest B-eDP1: SUCCESS (8.936s)
[334.222371] Starting dynamic subtest: C-eDP1
[343.139028] Dynamic subtest C-eDP1: SUCCESS (8.919s)
[343.148042] Starting dynamic subtest: D-eDP1
[352.070872] Dynamic subtest D-eDP1: SUCCESS (8.936s)
[352.076246] Subtest blocking-wf_vblank: SUCCESS (35.686s)
[353.332493] [035/134] (666s left) sysfs_heartbeat_interval (mixed)
[353.397064] Starting subtest: mixed
[353.399322] Starting dynamic subtest: vecs0
[358.721242] Dynamic subtest vecs0: SUCCESS (5.325s)
[358.732221] Starting dynamic subtest: ccs0
[363.933210] Dynamic subtest ccs0: SUCCESS (5.209s)
[363.944390] Starting dynamic subtest: vcs0
[369.187071] Dynamic subtest vcs0: SUCCESS (5.252s)
[369.198190] Starting dynamic subtest: bcs0
[374.388175] Dynamic subtest bcs0: SUCCESS (5.199s)
[374.399503] Starting dynamic subtest: rcs0
[379.567115] Dynamic subtest rcs0: SUCCESS (5.177s)
[379.578034] Starting dynamic subtest: vcs1
[384.836042] Dynamic subtest vcs1: SUCCESS (5.267s)
[384.838554] Subtest mixed: SUCCESS (31.442s)
[384.938265] [036/134] (634s left) kms_chamelium_edid (hdmi-edid-read)
[385.319070] Subtest hdmi-edid-read: SKIP (0.000s)
[386.110346] [037/134] (633s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180-async-flip)
[386.222536] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180-async-flip
[386.226876] Subtest y-tiled-max-hw-stride-32bpp-rotate-180-async-flip: SKIP (0.000s)
[386.350124] [038/134] (633s left) kms_rotation_crc (primary-x-tiled-reflect-x-180)
[386.451805] Starting subtest: primary-x-tiled-reflect-x-180
[393.473068] Subtest primary-x-tiled-reflect-x-180: SUCCESS (7.022s)
[394.729693] [039/134] (625s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-shrfb-draw-mmap-cpu)
[394.843758] Starting subtest: psr-1p-offscreen-pri-shrfb-draw-mmap-cpu
[401.425938] Subtest psr-1p-offscreen-pri-shrfb-draw-mmap-cpu: SUCCESS (6.585s)
[401.576422] [040/134] (618s left) drm_read (invalid-buffer)
[401.725068] Starting subtest: invalid-buffer
[401.727548] Subtest invalid-buffer: SUCCESS (0.000s)
[401.891598] [041/134] (618s left) i915_pm_freq_api (freq-basic-api)
[401.954821] Starting subtest: freq-basic-api
[401.957173] Starting dynamic subtest: gt0
[401.962394] Dynamic subtest gt0: SUCCESS (0.006s)
[401.973057] Starting dynamic subtest: gt1
[401.975220] Dynamic subtest gt1: SUCCESS (0.004s)
[401.977342] Subtest freq-basic-api: SUCCESS (0.012s)
[402.114906] [042/134] (617s left) dmabuf_sync_file (import-multiple-read-write)
[402.164054] Starting subtest: import-multiple-read-write
[402.166334] Subtest import-multiple-read-write: SUCCESS (0.003s)
[402.260111] [043/134] (617s left) kms_frontbuffer_tracking (fbc-2p-shrfb-fliptrack-mmap-gtt)
[402.372847] Starting subtest: fbc-2p-shrfb-fliptrack-mmap-gtt
[402.377024] Subtest fbc-2p-shrfb-fliptrack-mmap-gtt: SKIP (0.000s)
[402.511532] [044/134] (617s left) gen7_exec_parse (basic-allocation)
[402.566046] Subtest basic-allocation: SKIP (0.000s)
[402.669949] [045/134] (617s left) kms_big_fb (linear-addfb)
[402.773289] Starting subtest: linear-addfb
[402.775364] Subtest linear-addfb: SUCCESS (0.000s)
[402.904388] [046/134] (617s left) gem_busy (semaphore)
[403.105344] Subtest semaphore: SKIP (0.000s)
[403.368756] [047/134] (616s left) syncobj_wait (single-wait-all-for-submit-unsubmitted)
[403.424696] Starting subtest: single-wait-all-for-submit-unsubmitted
[403.529202] Subtest single-wait-all-for-submit-unsubmitted: SUCCESS (0.104s)
[403.632399] [048/134] (616s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf)
[408.603368] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf
[408.605385] Starting dynamic subtest: pipe-A-eDP-1
[409.396795] Dynamic subtest pipe-A-eDP-1: SKIP (0.790s)
[409.406232] Starting dynamic subtest: pipe-B-eDP-1
[410.530558] Dynamic subtest pipe-B-eDP-1: SKIP (1.133s)
[410.534789] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.927s)
[411.744294] [049/134] (608s left) kms_lease (lease-invalid-connector)
[411.841171] Starting subtest: lease-invalid-connector
[411.843450] Starting dynamic subtest: pipe-A-eDP-1
[411.845835] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[411.855041] Starting dynamic subtest: pipe-B-eDP-1
[411.857330] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[411.865450] Starting dynamic subtest: pipe-C-eDP-1
[411.867437] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[411.876333] Starting dynamic subtest: pipe-D-eDP-1
[411.878619] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[411.880898] Subtest lease-invalid-connector: SUCCESS (0.004s)
[411.942169] [050/134] (608s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-mmap-wc)
[412.054405] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-mmap-wc
[412.058452] Subtest psr-2p-scndscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[412.188826] [051/134] (608s left) kms_psr (fbc-psr2-primary-page-flip)
[412.287966] Starting subtest: fbc-psr2-primary-page-flip
[412.290223] Starting dynamic subtest: eDP-1
[412.294233] Dynamic subtest eDP-1: SKIP (0.000s)
[412.298279] Subtest fbc-psr2-primary-page-flip: SKIP (0.001s)
[412.389351] [052/134] (608s left) kms_frontbuffer_tracking (fbc-rgb101010-draw-mmap-wc)
[412.493679] Starting subtest: fbc-rgb101010-draw-mmap-wc
[417.115867] Subtest fbc-rgb101010-draw-mmap-wc: SUCCESS (4.625s)
[418.258060] [053/134] (602s left) kms_cursor_legacy (cursorb-vs-flipa-varying-size)
[418.380995] Starting subtest: cursorB-vs-flipA-varying-size
[418.385554] Subtest cursorB-vs-flipA-varying-size: SKIP (0.001s)
[418.553232] [054/134] (601s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-signaled)
[418.602306] Starting subtest: invalid-multi-wait-all-unsubmitted-signaled
[418.604218] Subtest invalid-multi-wait-all-unsubmitted-signaled: SUCCESS (0.000s)
[418.742154] [055/134] (601s left) api_intel_bb (blit-noreloc-purge-cache)
[418.796270] Starting subtest: blit-noreloc-purge-cache
[418.803492] Subtest blit-noreloc-purge-cache: SUCCESS (0.009s)
[418.955457] [056/134] (601s left) kms_chamelium_hpd (vga-hpd-enable-disable-mode)
[419.336773] Subtest vga-hpd-enable-disable-mode: SKIP (0.000s)
[420.130828] [057/134] (600s left) prime_busy (before-wait)
[420.191524] Starting subtest: before-wait
[420.197048] Starting dynamic subtest: rcs0
[420.253892] Dynamic subtest rcs0: SUCCESS (0.059s)
[420.264546] Starting dynamic subtest: bcs0
[420.324704] Dynamic subtest bcs0: SUCCESS (0.069s)
[420.335224] Starting dynamic subtest: vcs0
[420.365176] Dynamic subtest vcs0: SUCCESS (0.040s)
[420.373692] Starting dynamic subtest: vcs1
[420.405451] Dynamic subtest vcs1: SUCCESS (0.039s)
[420.414306] Starting dynamic subtest: vecs0
[420.446407] Dynamic subtest vecs0: SUCCESS (0.040s)
[420.455319] Starting dynamic subtest: ccs0
[420.486889] Dynamic subtest ccs0: SUCCESS (0.040s)
[420.595033] Subtest before-wait: SUCCESS (0.402s)
[420.697459] [058/134] (599s left) gem_ccs (ctrl-surf-copy-new-ctx)
[420.760485] Starting subtest: ctrl-surf-copy-new-ctx
[420.765085] Subtest ctrl-surf-copy-new-ctx: SKIP (0.000s)
[420.897418] [059/134] (599s left) gem_exec_schedule (preempt-self)
[420.969733] Starting subtest: preempt-self
[420.971677] Starting dynamic subtest: rcs0
[420.983229] Dynamic subtest rcs0: SUCCESS (0.021s)
[420.994423] Starting dynamic subtest: bcs0
[421.001064] Dynamic subtest bcs0: SUCCESS (0.017s)
[421.009651] Starting dynamic subtest: vcs0
[421.022566] Dynamic subtest vcs0: SUCCESS (0.021s)
[421.031103] Starting dynamic subtest: vcs1
[421.042282] Dynamic subtest vcs1: SUCCESS (0.019s)
[421.050831] Starting dynamic subtest: vecs0
[421.058891] Dynamic subtest vecs0: SUCCESS (0.016s)
[421.067132] Starting dynamic subtest: ccs0
[421.076955] Dynamic subtest ccs0: SUCCESS (0.017s)
[421.079252] Subtest preempt-self: SUCCESS (0.115s)
[423.075186] [060/134] (597s left) kms_ccs (crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc)
[423.177490] Starting subtest: crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc
[423.179665] Starting dynamic subtest: pipe-A-eDP-1
[424.047450] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.864s)
[424.055877] Starting dynamic subtest: pipe-B-eDP-1
[425.641158] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.592s)
[425.655058] Starting dynamic subtest: pipe-C-eDP-1
[427.202761] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.559s)
[427.211381] Starting dynamic subtest: pipe-D-eDP-1
[428.721401] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.517s)
[428.723675] Subtest crc-primary-rotation-180-4-tiled-mtl-rc-ccs-cc: SUCCESS (5.537s)
[429.916046] [061/134] (590s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-32bpp-yftileccs-downscaling)
[430.019333] Starting subtest: flip-32bpp-yftile-to-32bpp-yftileccs-downscaling
[430.021538] Starting dynamic subtest: pipe-A-default-mode
[430.309656] Dynamic subtest pipe-A-default-mode: SKIP (0.287s)
[430.314204] Subtest flip-32bpp-yftile-to-32bpp-yftileccs-downscaling: SKIP (0.288s)
[431.150527] [062/134] (589s left) kms_plane (planar-pixel-format-settings)
[431.252846] Starting subtest: planar-pixel-format-settings
[431.318800] Subtest planar-pixel-format-settings: SUCCESS (0.067s)
[431.469947] [063/134] (589s left) kms_psr2_sf (psr2-overlay-plane-update-continuous-sf)
[436.494657] Starting subtest: psr2-overlay-plane-update-continuous-sf
[436.497287] Starting dynamic subtest: pipe-A-eDP-1
[438.258474] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.762s)
[438.269432] Starting dynamic subtest: pipe-B-eDP-1
[439.980061] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.719s)
[439.982414] Subtest psr2-overlay-plane-update-continuous-sf: SUCCESS (3.486s)
[440.845783] [064/134] (580s left) syncobj_timeline (single-wait-all-for-submit-signaled)
[440.908526] Starting subtest: single-wait-all-for-submit-signaled
[440.910702] Subtest single-wait-all-for-submit-signaled: SUCCESS (0.000s)
[441.043168] [065/134] (579s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)
[441.098413] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[441.100328] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[441.231664] [066/134] (579s left) gen3_render_tiledx_blits
[441.365666] [067/134] (579s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-render)
[441.469984] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-render
[441.474056] Subtest psr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s)
[441.611696] [068/134] (579s left) gem_ctx_persistence (heartbeat-stop)
[441.677624] Starting subtest: heartbeat-stop
[441.682354] Subtest heartbeat-stop: SKIP (0.000s)
[441.806741] [069/134] (579s left) gem_mmap (pf-nonblock)
[441.870370] Subtest pf-nonblock: SKIP (0.000s)
[441.936059] [070/134] (579s left) prime_mmap (test_forked_cpu_write)
[441.996925] Starting subtest: test_forked_cpu_write
[441.998831] Starting dynamic subtest: test_forked_cpu_write-smem
[442.007736] Dynamic subtest test_forked_cpu_write-smem: SUCCESS (0.011s)
[442.009566] Subtest test_forked_cpu_write: SUCCESS (0.012s)
[442.136021] [071/134] (579s left) gem_exec_whisper (basic-contexts-all)
[442.194372] Starting subtest: basic-contexts-all
[453.878752] Subtest basic-contexts-all: SUCCESS (11.679s)
[454.085744] [072/134] (567s left) kms_cursor_crc (cursor-offscreen-max-size)
[454.366720] Starting subtest: cursor-offscreen-max-size
[454.373387] Subtest cursor-offscreen-max-size: SKIP (0.000s)
[454.545983] [073/134] (566s left) gem_exec_balancer (smoke)
[454.609292] Starting subtest: smoke
[477.234379] Subtest smoke: SUCCESS (22.623s)
[479.010104] [074/134] (542s left) kms_addfb_basic (size-max)
[479.117056] Starting subtest: size-max
[479.119355] Subtest size-max: SUCCESS (0.000s)
[479.254456] [075/134] (542s left) kms_pm_rpm (legacy-planes-dpms)
[481.082386] Starting subtest: legacy-planes-dpms
[481.084646] Starting dynamic subtest: plane-63
[489.376058] Dynamic subtest plane-63: SUCCESS (8.297s)
[489.387561] Starting dynamic subtest: plane-93
[497.681742] Dynamic subtest plane-93: SUCCESS (8.303s)
[497.692201] Starting dynamic subtest: plane-123
[506.001633] Dynamic subtest plane-123: SUCCESS (8.318s)
[506.012442] Starting dynamic subtest: plane-133
[514.621676] Dynamic subtest plane-133: SUCCESS (8.617s)
[514.624512] Subtest legacy-planes-dpms: SUCCESS (33.544s)
[515.000270] [076/134] (506s left) prime_self_import (basic-with_fd_dup)
[515.051710] Starting subtest: basic-with_fd_dup
[515.069087] Subtest basic-with_fd_dup: SUCCESS (0.019s)
[515.220183] [077/134] (506s left) kms_frontbuffer_tracking (fbcpsr-abgr161616f-draw-render)
[515.327067] Starting subtest: fbcpsr-abgr161616f-draw-render
[515.331148] Subtest fbcpsr-abgr161616f-draw-render: SKIP (0.000s)
[515.442096] [078/134] (506s left) kms_frontbuffer_tracking (psr-2p-primscrn-cur-indfb-draw-pwrite)
[515.542462] Starting subtest: psr-2p-primscrn-cur-indfb-draw-pwrite
[515.546517] Subtest psr-2p-primscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[515.678606] [079/134] (505s left) i915_drm_fdinfo (all-busy-idle-check-all)
[515.722614] Starting subtest: all-busy-idle-check-all
[515.727282] Subtest all-busy-idle-check-all: SKIP (0.003s)
[515.823685] [080/134] (505s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-indfb-draw-blt)
[515.981935] Starting subtest: psr-1p-primscrn-pri-indfb-draw-blt
[523.323571] Subtest psr-1p-primscrn-pri-indfb-draw-blt: SUCCESS (7.343s)
[523.466343] [081/134] (498s left) gem_exec_flush (basic-batch-kernel-default-uc)
[523.533972] Starting subtest: basic-batch-kernel-default-uc
[530.533087] Subtest basic-batch-kernel-default-uc: SUCCESS (6.999s)
[530.744268] [082/134] (490s left) i915_pm_rc6_residency (media-rc6-accuracy)
[530.795749] Starting subtest: media-rc6-accuracy
[530.800317] Subtest media-rc6-accuracy: SKIP (0.000s)
[530.930221] [083/134] (490s left) gem_ctx_shared (exec-single-timeline)
[531.003408] Starting subtest: exec-single-timeline
[531.005458] Starting dynamic subtest: rcs0
[532.082116] Dynamic subtest rcs0: SUCCESS (1.081s)
[532.093603] Starting dynamic subtest: bcs0
[533.169058] Dynamic subtest bcs0: SUCCESS (1.084s)
[533.181081] Starting dynamic subtest: vcs0
[534.257108] Dynamic subtest vcs0: SUCCESS (1.086s)
[534.266997] Starting dynamic subtest: vcs1
[535.345597] Dynamic subtest vcs1: SUCCESS (1.085s)
[535.355707] Starting dynamic subtest: vecs0
[536.433691] Dynamic subtest vecs0: SUCCESS (1.085s)
[536.443963] Starting dynamic subtest: ccs0
[537.522215] Dynamic subtest ccs0: SUCCESS (1.085s)
[537.525059] Subtest exec-single-timeline: SUCCESS (6.522s)
[537.737186] [084/134] (484s left) perf_pmu (invalid-init)
[537.775474] Starting subtest: invalid-init
[537.778210] Subtest invalid-init: SUCCESS (0.000s)
[537.923745] [085/134] (483s left) kms_invalid_mode (bad-vtotal)
[538.027135] Starting subtest: bad-vtotal
[538.029381] Starting dynamic subtest: pipe-A-eDP-1
[538.322781] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.294s)
[538.333337] Starting dynamic subtest: pipe-B-eDP-1
[538.335187] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.001s)
[538.343048] Starting dynamic subtest: pipe-C-eDP-1
[538.345326] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[538.353401] Starting dynamic subtest: pipe-D-eDP-1
[538.355572] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[538.357664] Subtest bad-vtotal: SUCCESS (0.300s)
[539.141145] [086/134] (482s left) kms_plane_scaling (planes-upscale-factor-0-25-downscale-factor-0-75)
[539.245091] Starting subtest: planes-upscale-factor-0-25-downscale-factor-0-75
[539.247340] Starting dynamic subtest: pipe-A
[539.267052] Dynamic subtest pipe-A: SKIP (0.019s)
[539.275952] Starting dynamic subtest: pipe-B
[539.303303] Dynamic subtest pipe-B: SKIP (0.034s)
[539.311854] Starting dynamic subtest: pipe-C
[539.338678] Dynamic subtest pipe-C: SKIP (0.034s)
[539.347318] Starting dynamic subtest: pipe-D
[539.376272] Dynamic subtest pipe-D: SKIP (0.034s)
[539.379923] Subtest planes-upscale-factor-0-25-downscale-factor-0-75: SKIP (0.127s)
[539.498187] [087/134] (482s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[539.559292] Starting subtest: multi-wait-for-submit-submitted-signaled
[539.561613] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.000s)
[539.694884] [088/134] (482s left) kms_psr (fbc-pr-sprite-mmap-cpu)
[539.793065] Starting subtest: fbc-pr-sprite-mmap-cpu
[539.797154] Subtest fbc-pr-sprite-mmap-cpu: SKIP (0.000s)
[539.885906] [089/134] (482s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-wc)
[539.992773] Starting subtest: fbc-rgb565-draw-mmap-wc
[544.072592] Subtest fbc-rgb565-draw-mmap-wc: SUCCESS (4.084s)
[545.252609] [090/134] (476s left) gem_fence_thrash (bo-write-verify-x)
[545.284725] Starting subtest: bo-write-verify-x
[545.306902] Subtest bo-write-verify-x: SKIP (0.018s)
[545.376380] [091/134] (476s left) template (b)
[545.424599] Starting subtest: B
[545.426634] Subtest B: SUCCESS (0.000s)
[545.559383] [092/134] (476s left) kms_big_fb (linear-max-hw-stride-64bpp-rotate-0-hflip)
[545.663492] Starting subtest: linear-max-hw-stride-64bpp-rotate-0-hflip
[545.667804] Subtest linear-max-hw-stride-64bpp-rotate-0-hflip: SKIP (0.000s)
[545.800320] [093/134] (476s left) kms_universal_plane (universal-plane-functional)
[545.898040] Starting subtest: universal-plane-functional
[545.899841] Starting dynamic subtest: pipe-A-eDP-1
[549.985936] Dynamic subtest pipe-A-eDP-1: SUCCESS (4.088s)
[549.995052] Starting dynamic subtest: pipe-B-eDP-1
[554.684250] Dynamic subtest pipe-B-eDP-1: SUCCESS (4.694s)
[554.693439] Starting dynamic subtest: pipe-C-eDP-1
[559.020178] Dynamic subtest pipe-C-eDP-1: SUCCESS (4.336s)
[559.029981] Starting dynamic subtest: pipe-D-eDP-1
[563.411640] Dynamic subtest pipe-D-eDP-1: SUCCESS (4.388s)
[563.414267] Subtest universal-plane-functional: SUCCESS (17.513s)
[564.229447] [094/134] (457s left) kms_cursor_legacy (nonblocking-modeset-vs-cursor-atomic)
[564.355303] Starting subtest: nonblocking-modeset-vs-cursor-atomic
[565.791263] Subtest nonblocking-modeset-vs-cursor-atomic: SUCCESS (1.435s)
[566.618777] [095/134] (455s left) kms_chamelium_color (ctm-green-to-red)
[566.706045] Subtest ctm-green-to-red: SKIP (0.000s)
[566.763762] [096/134] (455s left) syncobj_timeline (invalid-signal-bad-pad)
[566.819620] Starting subtest: invalid-signal-bad-pad
[566.821581] Subtest invalid-signal-bad-pad: SUCCESS (0.000s)
[566.938961] [097/134] (455s left) gem_eio (banned)
[567.157345] Starting subtest: banned
[567.747954] Subtest banned: SUCCESS (0.591s)
[567.945138] [098/134] (454s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling)
[568.035225] Starting subtest: flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling
[568.037178] Starting dynamic subtest: pipe-A-default-mode
[568.329481] Dynamic subtest pipe-A-default-mode: SKIP (0.290s)
[568.334168] Subtest flip-64bpp-ytile-to-32bpp-ytilegen12rcccs-upscaling: SKIP (0.291s)
[569.140657] [099/134] (453s left) kms_psr (psr-cursor-render)
[569.233085] Starting subtest: psr-cursor-render
[569.235514] Starting dynamic subtest: eDP-1
[570.913545] Dynamic subtest eDP-1: SUCCESS (1.681s)
[570.915850] Subtest psr-cursor-render: SUCCESS (1.683s)
[571.801859] [100/134] (450s left) syncobj_wait (single-wait-for-submit-submitted)
[571.865368] Starting subtest: single-wait-for-submit-submitted
[571.969061] Subtest single-wait-for-submit-submitted: SUCCESS (0.103s)
[572.068916] [101/134] (450s left) perf (gen12-group-concurrent-oa-buffer-read)
[572.200776] Starting subtest: gen12-group-concurrent-oa-buffer-read
[582.243332] Subtest gen12-group-concurrent-oa-buffer-read: SUCCESS (10.042s)
[582.292397] [102/134] (440s left) gem_lmem_swapping (verify-random-ccs)
[582.336220] Subtest verify-random-ccs: SKIP (0.000s)
[582.386830] [103/134] (440s left) kms_lease (lease-invalid-plane)
[582.483430] Starting subtest: lease-invalid-plane
[582.485816] Starting dynamic subtest: pipe-A-eDP-1
[582.488246] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[582.499178] Starting dynamic subtest: pipe-B-eDP-1
[582.500991] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[582.509458] Starting dynamic subtest: pipe-C-eDP-1
[582.511677] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[582.520148] Starting dynamic subtest: pipe-D-eDP-1
[582.522240] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[582.524321] Subtest lease-invalid-plane: SUCCESS (0.005s)
[582.580722] [104/134] (440s left) gem_ctx_isolation (clean)
[582.649288] Starting subtest: clean
[582.651575] Starting dynamic subtest: rcs0
[582.721385] Dynamic subtest rcs0: SUCCESS (0.072s)
[582.730656] Starting dynamic subtest: bcs0
[582.825874] Dynamic subtest bcs0: SUCCESS (0.103s)
[582.834702] Starting dynamic subtest: vcs0
[582.903070] Dynamic subtest vcs0: SUCCESS (0.076s)
[582.911960] Starting dynamic subtest: vcs1
[584.921443] Dynamic subtest vcs1: SUCCESS (2.017s)
[584.930356] Starting dynamic subtest: vecs0
[586.938290] Dynamic subtest vecs0: SUCCESS (2.015s)
[586.947201] Starting dynamic subtest: ccs0
[588.933034] Dynamic subtest ccs0: SUCCESS (1.993s)
[588.935733] Subtest clean: SUCCESS (6.283s)
[589.205115] [105/134] (433s left) gem_tiled_blits (interruptible)
[589.284415] Subtest interruptible: SKIP (0.000s)
[589.370312] [106/134] (433s left) gem_mmap_wc (write-cpu-read-wc-unflushed)
[589.438324] Subtest write-cpu-read-wc-unflushed: SKIP (0.000s)
[589.495684] [107/134] (433s left) gem_spin_batch (resubmit-all)
[589.568283] Starting subtest: resubmit-all
[589.570528] Starting dynamic subtest: rcs0
[589.584683] Dynamic subtest rcs0: SUCCESS (0.016s)
[589.598884] Starting dynamic subtest: bcs0
[589.601763] Dynamic subtest bcs0: SUCCESS (0.003s)
[589.610604] Starting dynamic subtest: vcs0
[589.612712] Dynamic subtest vcs0: SUCCESS (0.004s)
[589.620785] Starting dynamic subtest: vcs1
[589.622632] Dynamic subtest vcs1: SUCCESS (0.003s)
[589.630670] Starting dynamic subtest: vecs0
[589.632596] Dynamic subtest vecs0: SUCCESS (0.004s)
[589.640837] Starting dynamic subtest: ccs0
[589.642773] Dynamic subtest ccs0: SUCCESS (0.005s)
[589.644665] Subtest resubmit-all: SUCCESS (0.042s)
[589.882396] [108/134] (432s left) kms_frontbuffer_tracking (fbcpsr-modesetfrombusy)
[589.985081] Starting subtest: fbcpsr-modesetfrombusy
[596.268838] Subtest fbcpsr-modesetfrombusy: SUCCESS (6.286s)
[596.511721] [109/134] (426s left) gem_ctx_param (invalid-param-get)
[596.611862] Starting subtest: invalid-param-get
[596.622114] Subtest invalid-param-get: SUCCESS (0.001s)
[596.776315] [110/134] (426s left) kms_cursor_legacy (forked-bo)
[596.925166] Starting subtest: forked-bo
[596.935884] Starting dynamic subtest: pipe-A
[602.372403] Dynamic subtest pipe-A: SUCCESS (5.467s)
[602.386636] Starting dynamic subtest: pipe-B
[607.853055] Dynamic subtest pipe-B: SUCCESS (5.477s)
[607.868287] Starting dynamic subtest: pipe-C
[613.333530] Dynamic subtest pipe-C: SUCCESS (5.479s)
[613.344674] Starting dynamic subtest: pipe-D
[618.809284] Dynamic subtest pipe-D: SUCCESS (5.473s)
[618.820493] Starting dynamic subtest: all-pipes
[624.308337] Dynamic subtest all-pipes: SUCCESS (5.496s)
[624.310764] Subtest forked-bo: SUCCESS (27.403s)
[624.480476] [111/134] (398s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu)
[624.588691] Starting subtest: fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu
[631.631339] Subtest fbcpsr-1p-primscrn-pri-indfb-draw-mmap-cpu: SUCCESS (7.044s)
[631.781426] [112/134] (391s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite)
[631.885120] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite
[631.889270] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[632.027375] [113/134] (391s left) kms_flip (2x-plain-flip-fb-recreate)
[632.135081] Starting subtest: 2x-plain-flip-fb-recreate
[632.147707] Subtest 2x-plain-flip-fb-recreate: SKIP (0.012s)
[632.250502] [114/134] (390s left) gen9_exec_parse (bb-oversize)
[632.317393] Subtest bb-oversize: SKIP (0.000s)
[632.392074] [115/134] (390s left) kms_frontbuffer_tracking (basic)
[632.495509] Starting subtest: basic
[635.846301] Subtest basic: SUCCESS (3.354s)
[636.007657] [116/134] (387s left) gem_set_tiling_vs_blt (untiled-to-tiled)
[636.086440] Subtest untiled-to-tiled: SKIP (0.000s)
[636.170909] [117/134] (387s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-render)
[636.280425] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-render
[636.283829] Subtest psr-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[636.435654] [118/134] (386s left) perf (oa-formats)
[636.551317] Starting subtest: oa-formats
[636.553124] Starting dynamic subtest: 0-rcs0
[636.560924] Dynamic subtest 0-rcs0: SUCCESS (0.012s)
[636.569699] Starting dynamic subtest: 1-vecs0
[636.582943] Dynamic subtest 1-vecs0: SUCCESS (0.021s)
[636.585278] Subtest oa-formats: SUCCESS (0.034s)
[636.626226] [119/134] (386s left) kms_ccs (bad-pixel-format-4-tiled-dg2-rc-ccs-cc)
[636.726559] Starting subtest: bad-pixel-format-4-tiled-dg2-rc-ccs-cc
[636.728468] Starting dynamic subtest: pipe-A-eDP-1
[636.747535] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s)
[636.758272] Starting dynamic subtest: pipe-B-eDP-1
[636.777055] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s)
[636.787432] Starting dynamic subtest: pipe-C-eDP-1
[636.805325] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s)
[636.813760] Starting dynamic subtest: pipe-D-eDP-1
[636.832665] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s)
[636.836039] Subtest bad-pixel-format-4-tiled-dg2-rc-ccs-cc: SKIP (0.005s)
[639.044380] [120/134] (384s left) gem_partial_pwrite_pread (reads-display)
[639.108762] Subtest reads-display: SKIP (0.000s)
[639.186761] [121/134] (384s left) syncobj_timeline (32bits-limit)
[639.246333] Starting subtest: 32bits-limit
[639.248678] Subtest 32bits-limit: SUCCESS (0.001s)
[639.387059] [122/134] (384s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[639.487996] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[639.492285] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[639.611454] [123/134] (383s left) kms_async_flips (async-flip-dpms)
[639.717655] Starting subtest: async-flip-dpms
[640.097299] Starting dynamic subtest: pipe-A-eDP-1
[643.933278] Dynamic subtest pipe-A-eDP-1: SUCCESS (3.835s)
[644.322717] Starting dynamic subtest: pipe-B-eDP-1
[647.098011] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.783s)
[647.485413] Starting dynamic subtest: pipe-C-eDP-1
[650.252917] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.774s)
[650.647312] Starting dynamic subtest: pipe-D-eDP-1
[653.425796] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.786s)
[653.427937] Subtest async-flip-dpms: SUCCESS (13.710s)
[654.629129] [124/134] (368s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-blt)
[654.730142] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-blt
[654.734082] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-blt: SKIP (0.000s)
[654.862819] [125/134] (368s left) gem_mmap_gtt (hang-busy)
[654.927554] Subtest hang-busy: SKIP (0.000s)
[655.002126] [126/134] (368s left) api_intel_bb (object-noreloc-purge-cache-simple)
[655.053087] Starting subtest: object-noreloc-purge-cache-simple
[655.056018] Subtest object-noreloc-purge-cache-simple: SUCCESS (0.005s)
[655.213788] [127/134] (368s left) gem_exec_balancer (fairslice)
[655.276722] Starting subtest: fairslice
[658.181346] Subtest fairslice: SUCCESS (2.903s)
[658.526249] [128/134] (365s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers)
[658.624918] Starting subtest: plane-upscale-factor-0-25-with-modifiers
[658.627227] Starting dynamic subtest: pipe-A
[658.983691] Dynamic subtest pipe-A: SUCCESS (0.360s)
[658.993075] Starting dynamic subtest: pipe-B
[660.413680] Dynamic subtest pipe-B: SUCCESS (1.427s)
[660.428608] Starting dynamic subtest: pipe-C
[661.829994] Dynamic subtest pipe-C: SUCCESS (1.413s)
[661.849989] Starting dynamic subtest: pipe-D
[663.253240] Dynamic subtest pipe-D: SUCCESS (1.423s)
[663.255483] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.632s)
[664.453187] [129/134] (359s left) kms_dsc (dsc-with-output-formats)
[664.554304] Starting subtest: dsc-with-output-formats
[664.576514] Subtest dsc-with-output-formats: SKIP (0.000s)
[664.652862] [130/134] (359s left) kms_big_fb (yf-tiled-16bpp-rotate-270)
[664.762828] Starting subtest: yf-tiled-16bpp-rotate-270
[664.767414] Subtest yf-tiled-16bpp-rotate-270: SKIP (0.000s)
[664.906086] [131/134] (358s left) kms_psr (psr2-primary-mmap-gtt)
[665.004059] Starting subtest: psr2-primary-mmap-gtt
[665.006260] Starting dynamic subtest: eDP-1
[666.413091] Dynamic subtest eDP-1: SKIP (1.406s)
[666.418402] Subtest psr2-primary-mmap-gtt: SKIP (1.408s)
[666.639876] [132/134] (357s left) kms_atomic (atomic-plane-damage)
[666.736318] Starting subtest: atomic-plane-damage
[666.791884] Starting dynamic subtest: pipe-A-eDP-1
[667.329851] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.539s)
[667.332100] Subtest atomic-plane-damage: SUCCESS (0.596s)
[668.210705] [133/134] (355s left) kms_ccs (missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc)
[668.308341] Starting subtest: missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc
[668.310634] Starting dynamic subtest: pipe-A-eDP-1
[668.330591] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.000s)
[668.340691] Starting dynamic subtest: pipe-B-eDP-1
[668.359675] Dynamic subtest pipe-B-eDP-1: SUCCESS (0.000s)
[668.367865] Starting dynamic subtest: pipe-C-eDP-1
[668.386470] Dynamic subtest pipe-C-eDP-1: SUCCESS (0.000s)
[668.394977] Starting dynamic subtest: pipe-D-eDP-1
[668.414255] Dynamic subtest pipe-D-eDP-1: SUCCESS (0.000s)
[668.416151] Subtest missing-ccs-buffer-4-tiled-mtl-rc-ccs-cc: SUCCESS (0.006s)
[670.580382] [134/134] (353s left) gem_mmap (short-mmap)
[670.644610] Subtest short-mmap: SKIP (0.000s)
[670.699091] Closing watchdogs
results: parsing output: 0/ for test: kms_cursor_edge_walk
results: parsing output: 1/ for test: kms_pipe_stress
results: parsing output: 2/ for test: kms_big_fb
results: parsing output: 3/ for test: gem_exec_whisper
results: parsing output: 4/ for test: gem_render_copy
results: parsing output: 5/ for test: gem_flink_race
results: parsing output: 6/ for test: kms_ccs
results: parsing output: 7/ for test: gem_ringfill
results: parsing output: 8/ for test: kms_psr
results: parsing output: 9/ for test: vgem_basic
results: parsing output: 10/ for test: gem_exec_schedule
results: parsing output: 11/ for test: gem_exec_schedule
results: parsing output: 12/ for test: kms_flip
results: parsing output: 13/ for test: kms_cursor_crc
results: parsing output: 14/ for test: gem_exec_flush
results: parsing output: 15/ for test: kms_vblank
results: parsing output: 16/ for test: gem_softpin
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: kms_flip_scaled_crc
results: parsing output: 19/ for test: perf_pmu
results: parsing output: 20/ for test: kms_color
results: parsing output: 21/ for test: i915_query
results: parsing output: 22/ for test: gem_render_copy
results: parsing output: 23/ for test: gem_exec_fence
results: parsing output: 24/ for test: kms_big_fb
results: parsing output: 25/ for test: kms_properties
results: parsing output: 26/ for test: syncobj_timeline
results: parsing output: 27/ for test: kms_big_fb
results: parsing output: 28/ for test: kms_flip
results: parsing output: 29/ for test: gem_pxp
results: parsing output: 30/ for test: gem_mmap_wc
results: parsing output: 31/ for test: kms_content_protection
results: parsing output: 32/ for test: kms_frontbuffer_tracking
results: parsing output: 33/ for test: kms_flip
results: parsing output: 34/ for test: sysfs_heartbeat_interval
results: parsing output: 35/ for test: kms_chamelium_edid
results: parsing output: 36/ for test: kms_big_fb
results: parsing output: 37/ for test: kms_rotation_crc
results: parsing output: 38/ for test: kms_frontbuffer_tracking
results: parsing output: 39/ for test: drm_read
results: parsing output: 40/ for test: i915_pm_freq_api
results: parsing output: 41/ for test: dmabuf_sync_file
results: parsing output: 42/ for test: kms_frontbuffer_tracking
results: parsing output: 43/ for test: gen7_exec_parse
results: parsing output: 44/ for test: kms_big_fb
results: parsing output: 45/ for test: gem_busy
results: parsing output: 46/ for test: syncobj_wait
results: parsing output: 47/ for test: kms_psr2_sf
results: parsing output: 48/ for test: kms_lease
results: parsing output: 49/ for test: kms_frontbuffer_tracking
results: parsing output: 50/ for test: kms_psr
results: parsing output: 51/ for test: kms_frontbuffer_tracking
results: parsing output: 52/ for test: kms_cursor_legacy
results: parsing output: 53/ for test: syncobj_wait
results: parsing output: 54/ for test: api_intel_bb
results: parsing output: 55/ for test: kms_chamelium_hpd
results: parsing output: 56/ for test: prime_busy
results: parsing output: 57/ for test: gem_ccs
results: parsing output: 58/ for test: gem_exec_schedule
results: parsing output: 59/ for test: kms_ccs
results: parsing output: 60/ for test: kms_flip_scaled_crc
results: parsing output: 61/ for test: kms_plane
results: parsing output: 62/ for test: kms_psr2_sf
results: parsing output: 63/ for test: syncobj_timeline
results: parsing output: 64/ for test: syncobj_wait
results: parsing output: 65/ for test: gen3_render_tiledx_blits
results: parsing output: 66/ for test: kms_frontbuffer_tracking
results: parsing output: 67/ for test: gem_ctx_persistence
results: parsing output: 68/ for test: gem_mmap
results: parsing output: 69/ for test: prime_mmap
results: parsing output: 70/ for test: gem_exec_whisper
results: parsing output: 71/ for test: kms_cursor_crc
results: parsing output: 72/ for test: gem_exec_balancer
results: parsing output: 73/ for test: kms_addfb_basic
results: parsing output: 74/ for test: kms_pm_rpm
results: parsing output: 75/ for test: prime_self_import
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: kms_frontbuffer_tracking
results: parsing output: 78/ for test: i915_drm_fdinfo
results: parsing output: 79/ for test: kms_frontbuffer_tracking
results: parsing output: 80/ for test: gem_exec_flush
results: parsing output: 81/ for test: i915_pm_rc6_residency
results: parsing output: 82/ for test: gem_ctx_shared
results: parsing output: 83/ for test: perf_pmu
results: parsing output: 84/ for test: kms_invalid_mode
results: parsing output: 85/ for test: kms_plane_scaling
results: parsing output: 86/ for test: syncobj_timeline
results: parsing output: 87/ for test: kms_psr
results: parsing output: 88/ for test: kms_frontbuffer_tracking
results: parsing output: 89/ for test: gem_fence_thrash
results: parsing output: 90/ for test: template
results: parsing output: 91/ for test: kms_big_fb
results: parsing output: 92/ for test: kms_universal_plane
results: parsing output: 93/ for test: kms_cursor_legacy
results: parsing output: 94/ for test: kms_chamelium_color
results: parsing output: 95/ for test: syncobj_timeline
results: parsing output: 96/ for test: gem_eio
results: parsing output: 97/ for test: kms_flip_scaled_crc
results: parsing output: 98/ for test: kms_psr
results: parsing output: 99/ for test: syncobj_wait
results: parsing output: 100/ for test: perf
results: parsing output: 101/ for test: gem_lmem_swapping
results: parsing output: 102/ for test: kms_lease
results: parsing output: 103/ for test: gem_ctx_isolation
results: parsing output: 104/ for test: gem_tiled_blits
results: parsing output: 105/ for test: gem_mmap_wc
results: parsing output: 106/ for test: gem_spin_batch
results: parsing output: 107/ for test: kms_frontbuffer_tracking
results: parsing output: 108/ for test: gem_ctx_param
results: parsing output: 109/ for test: kms_cursor_legacy
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: kms_frontbuffer_tracking
results: parsing output: 112/ for test: kms_flip
results: parsing output: 113/ for test: gen9_exec_parse
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: gem_set_tiling_vs_blt
results: parsing output: 116/ for test: kms_frontbuffer_tracking
results: parsing output: 117/ for test: perf
results: parsing output: 118/ for test: kms_ccs
results: parsing output: 119/ for test: gem_partial_pwrite_pread
results: parsing output: 120/ for test: syncobj_timeline
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: kms_async_flips
results: parsing output: 123/ for test: kms_frontbuffer_tracking
results: parsing output: 124/ for test: gem_mmap_gtt
results: parsing output: 125/ for test: api_intel_bb
results: parsing output: 126/ for test: gem_exec_balancer
results: parsing output: 127/ for test: kms_plane_scaling
results: parsing output: 128/ for test: kms_dsc
results: parsing output: 129/ for test: kms_big_fb
results: parsing output: 130/ for test: kms_psr
results: parsing output: 131/ for test: kms_atomic
results: parsing output: 132/ for test: kms_ccs
results: parsing output: 133/ for test: gem_mmap
Done.