[61.488651] Initializing watchdogs [61.488707] /dev/watchdog0 [61.503705] [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] [61.508295] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [61.510656] [FACT before any test] new: kernel.kmod_is_loaded.i915: true [61.512507] [001/133] (960s left) kms_rmfb (rmfb-ioctl) [61.608877] Starting subtest: rmfb-ioctl [61.609730] Starting dynamic subtest: pipe-A-eDP-1 [61.726990] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.117s) [61.735730] Starting dynamic subtest: pipe-B-eDP-1 [62.886315] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.154s) [62.894124] Starting dynamic subtest: pipe-C-eDP-1 [64.016589] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.126s) [64.022910] Starting dynamic subtest: pipe-D-eDP-1 [65.139359] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.119s) [65.140538] Subtest rmfb-ioctl: SUCCESS (3.520s) [66.262659] [002/133] (955s left) gem_mmap_wc (bad-object) [66.317554] Subtest bad-object: SKIP (0.000s) [66.372589] [003/133] (955s left) kms_selftest (drm_cmdline_parser) [66.404358] Starting subtest: drm_cmdline_parser [66.413312] Starting dynamic subtest: drm_test_cmdline_force_d_only [66.519499] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.106s) [66.527679] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi [66.605459] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.085s) [66.612963] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi [66.700655] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.093s) [66.708187] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital [66.794643] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.094s) [66.802085] Starting dynamic subtest: drm_test_cmdline_force_e_only [66.889077] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.094s) [66.896515] Starting dynamic subtest: drm_test_cmdline_res [66.986376] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.096s) [66.993951] Starting dynamic subtest: drm_test_cmdline_res_vesa [67.082215] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.095s) [67.089383] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank [67.179873] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.098s) [67.187492] Starting dynamic subtest: drm_test_cmdline_res_rblank [67.288399] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.101s) [67.296525] Starting dynamic subtest: drm_test_cmdline_res_bpp [67.379630] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.088s) [67.387094] Starting dynamic subtest: drm_test_cmdline_res_refresh [67.474352] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.102s) [67.481152] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh [67.562103] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.087s) [67.569336] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced [67.679797] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.118s) [67.687800] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins [67.795060] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.114s) [67.802858] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off [67.886584] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.092s) [67.894384] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on [67.990179] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.102s) [67.997864] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog [68.096546] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.106s) [68.103395] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital [68.196177] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.100s) [68.203416] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on [68.291022] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.095s) [68.298698] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on [68.402051] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.110s) [68.409355] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins [68.508287] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.106s) [68.516466] Starting dynamic subtest: drm_test_cmdline_name [68.622101] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.113s) [68.629257] Starting dynamic subtest: drm_test_cmdline_name_bpp [68.716517] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.094s) [68.722133] Starting dynamic subtest: drm_test_cmdline_name_option [68.816147] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.099s) [68.823170] Starting dynamic subtest: drm_test_cmdline_name_bpp_option [68.894777] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.079s) [68.902365] Starting dynamic subtest: drm_test_cmdline_rotate_0 [69.003932] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.109s) [69.009574] Starting dynamic subtest: drm_test_cmdline_rotate_90 [69.105977] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.100s) [69.112803] Starting dynamic subtest: drm_test_cmdline_rotate_180 [69.203775] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.097s) [69.212036] Starting dynamic subtest: drm_test_cmdline_rotate_270 [69.300048] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.095s) [69.307912] Starting dynamic subtest: drm_test_cmdline_hmirror [69.377820] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.078s) [69.383419] Starting dynamic subtest: drm_test_cmdline_vmirror [69.471889] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.094s) [69.480060] Starting dynamic subtest: drm_test_cmdline_margin_options [69.566047] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.093s) [69.573878] Starting dynamic subtest: drm_test_cmdline_multiple_options [69.661082] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.095s) [69.667486] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option [69.750254] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.088s) [69.756763] Starting dynamic subtest: drm_test_cmdline_extra_and_option [69.846904] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.097s) [69.854819] Starting dynamic subtest: drm_test_cmdline_freestanding_options [69.939082] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.090s) [69.946884] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options [70.015730] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.077s) [70.022654] Starting dynamic subtest: drm_test_cmdline_panel_orientation [70.102367] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.086s) [70.109588] Starting dynamic subtest: drm_test_cmdline_invalid [70.192954] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.091s) [70.198773] Starting dynamic subtest: drm_test_cmdline_tv_options [70.297258] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.104s) [70.298090] Subtest drm_cmdline_parser: SUCCESS (3.887s) [70.451261] [004/133] (951s left) kms_pm_rpm (dpms-mode-unset-non-lpsp) [72.495094] Starting subtest: dpms-mode-unset-non-lpsp [73.653292] Subtest dpms-mode-unset-non-lpsp: SKIP (1.157s) [74.012206] [005/133] (948s left) i915_selftest (live) [75.716488] Starting subtest: live [75.717780] Starting dynamic subtest: sanitycheck [80.103029] Dynamic subtest sanitycheck: SUCCESS (4.385s) [80.113585] Starting dynamic subtest: uncore [84.447976] Dynamic subtest uncore: SUCCESS (4.343s) [84.456471] Starting dynamic subtest: workarounds [101.178227] Dynamic subtest workarounds: FAIL (16.519s) [101.184043] Starting dynamic subtest: gt_engines [105.510987] Dynamic subtest gt_engines: SUCCESS (4.542s) [105.519619] Starting dynamic subtest: gt_timelines [121.484811] Dynamic subtest gt_timelines: SUCCESS (15.973s) [121.493362] Starting dynamic subtest: gt_contexts [125.840077] Dynamic subtest gt_contexts: SUCCESS (4.354s) [125.849231] Starting dynamic subtest: gt_lrc [130.176544] Dynamic subtest gt_lrc: SUCCESS (4.335s) [130.184455] Starting dynamic subtest: gt_mocs [133.142712] Dynamic subtest gt_mocs: SUCCESS (2.965s) [133.150359] Starting dynamic subtest: gt_pm [139.924325] Dynamic subtest gt_pm: SUCCESS (6.780s) [139.932681] Starting dynamic subtest: gt_heartbeat [144.514071] Dynamic subtest gt_heartbeat: SUCCESS (4.599s) [144.522751] Starting dynamic subtest: gt_tlb [153.897505] Dynamic subtest gt_tlb: SUCCESS (9.373s) [153.904872] Starting dynamic subtest: requests [165.552996] Dynamic subtest requests: SUCCESS (11.655s) [165.561058] Starting dynamic subtest: migrate [173.318806] Dynamic subtest migrate: SUCCESS (7.764s) [173.327178] Starting dynamic subtest: active [177.648792] Dynamic subtest active: SUCCESS (4.328s) [177.657275] Starting dynamic subtest: objects [182.431916] Dynamic subtest objects: SUCCESS (4.782s) [182.440051] Starting dynamic subtest: mman [187.209906] Dynamic subtest mman: SUCCESS (4.779s) [187.215675] Starting dynamic subtest: dmabuf [189.998722] Dynamic subtest dmabuf: SUCCESS (2.787s) [190.007358] Starting dynamic subtest: vma [194.375530] Dynamic subtest vma: SUCCESS (4.375s) [194.383933] Starting dynamic subtest: coherency [199.382441] Dynamic subtest coherency: SUCCESS (5.005s) [199.391197] Starting dynamic subtest: gtt [211.187976] Dynamic subtest gtt: SUCCESS (11.804s) [211.196625] Starting dynamic subtest: gem [216.990803] Dynamic subtest gem: SUCCESS (5.801s) [216.999420] Starting dynamic subtest: evict [221.071285] Dynamic subtest evict: SUCCESS (4.078s) [221.079630] Starting dynamic subtest: hugepages [231.758582] Dynamic subtest hugepages: SUCCESS (10.685s) [231.766300] Starting dynamic subtest: gem_contexts [260.488561] Dynamic subtest gem_contexts: SUCCESS (28.727s) [260.496967] Starting dynamic subtest: client [263.266505] Dynamic subtest client: SUCCESS (2.777s) [263.276295] Starting dynamic subtest: gem_migrate [267.590446] Dynamic subtest gem_migrate: SUCCESS (4.322s) [267.598709] Starting dynamic subtest: reset [271.962819] Dynamic subtest reset: SUCCESS (4.371s) [271.971035] Starting dynamic subtest: memory_region [276.308505] Dynamic subtest memory_region: SUCCESS (4.346s) [276.317272] Starting dynamic subtest: hangcheck [289.236668] Dynamic subtest hangcheck: SUCCESS (12.926s) [289.244653] Starting dynamic subtest: execlists [293.596771] Dynamic subtest execlists: SUCCESS (4.357s) [293.605493] Starting dynamic subtest: ring_submission [297.901375] Dynamic subtest ring_submission: SUCCESS (4.303s) [297.906903] Starting dynamic subtest: perf [302.296502] Dynamic subtest perf: SUCCESS (4.393s) [302.303085] Starting dynamic subtest: slpc [316.417772] Dynamic subtest slpc: SUCCESS (14.117s) [316.426386] Starting dynamic subtest: guc [320.305765] Dynamic subtest guc: SUCCESS (3.886s) [320.314341] Starting dynamic subtest: guc_multi_lrc [324.662766] Dynamic subtest guc_multi_lrc: SUCCESS (4.355s) [324.670817] Starting dynamic subtest: guc_hang [329.616053] Dynamic subtest guc_hang: SUCCESS (4.951s) [329.622998] Starting dynamic subtest: late_gt_pm [333.936989] Dynamic subtest late_gt_pm: SUCCESS (4.318s) [333.938180] Subtest live: FAIL (258.206s) [333.957057] [FACT i915_selftest (live)] deleted: kernel.kmod_is_loaded.i915: true [333.958536] [006/133] (688s left) gem_partial_pwrite_pread (reads) [335.523632] Subtest reads: SKIP (0.000s) [335.617244] [FACT gem_partial_pwrite_pread (reads)] new: kernel.kmod_is_loaded.i915: true [335.620185] [007/133] (686s left) gem_softpin (overlap) [335.672940] Starting subtest: overlap [336.680280] Subtest overlap: SUCCESS (0.997s) [336.800441] [008/133] (685s left) gem_exec_balancer (parallel-keep-in-fence) [337.084585] Starting subtest: parallel-keep-in-fence [338.274147] Subtest parallel-keep-in-fence: SUCCESS (1.190s) [338.381806] [009/133] (683s left) gem_exec_store (dword) [338.439815] Starting subtest: dword [338.440719] Starting dynamic subtest: rcs0 [338.518838] Dynamic subtest rcs0: SUCCESS (0.078s) [338.529828] Starting dynamic subtest: bcs0 [338.565240] Dynamic subtest bcs0: SUCCESS (0.044s) [338.578299] Starting dynamic subtest: vcs0 [338.610740] Dynamic subtest vcs0: SUCCESS (0.043s) [338.622042] Starting dynamic subtest: vcs1 [338.654793] Dynamic subtest vcs1: SUCCESS (0.043s) [338.664502] Starting dynamic subtest: vecs0 [338.699963] Dynamic subtest vecs0: SUCCESS (0.043s) [338.709198] Starting dynamic subtest: ccs0 [338.744627] Dynamic subtest ccs0: SUCCESS (0.042s) [338.746044] Subtest dword: SUCCESS (0.306s) [338.922520] [010/133] (683s left) syncobj_timeline (single-wait-all-available-signaled) [338.974162] Starting subtest: single-wait-all-available-signaled [338.975037] Subtest single-wait-all-available-signaled: SUCCESS (0.000s) [339.078353] [011/133] (683s left) kms_psr (fbc-psr2-sprite-plane-move) [339.161184] Starting subtest: fbc-psr2-sprite-plane-move [339.162073] Starting dynamic subtest: eDP-1 [339.163802] Dynamic subtest eDP-1: SKIP (0.000s) [339.165676] Subtest fbc-psr2-sprite-plane-move: SKIP (0.001s) [339.236109] [012/133] (683s left) kms_cursor_legacy (cursora-vs-flipa-atomic-transitions) [339.360678] Starting subtest: cursorA-vs-flipA-atomic-transitions [350.553290] Subtest cursorA-vs-flipA-atomic-transitions: SUCCESS (11.191s) [351.409470] [013/133] (671s left) gem_flink_basic (flink-lifetime) [351.476195] Starting subtest: flink-lifetime [351.478379] Subtest flink-lifetime: SUCCESS (0.002s) [351.575436] [014/133] (670s left) core_setmaster (master-drop-set-shared-fd) [351.643949] Starting subtest: master-drop-set-shared-fd [351.665724] Subtest master-drop-set-shared-fd: SUCCESS (0.022s) [351.694336] [015/133] (670s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-move) [351.777571] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-move [351.779354] Subtest fbcpsr-2p-scndscrn-spr-indfb-move: SKIP (0.000s) [351.864989] [016/133] (670s left) perf (polling-small-buf) [352.004323] Starting subtest: polling-small-buf [352.095463] Subtest polling-small-buf: SUCCESS (0.090s) [352.145083] [017/133] (670s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render) [352.240379] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render [359.286496] Subtest psr-1p-offscreen-pri-indfb-draw-render: SUCCESS (7.045s) [359.415835] [018/133] (663s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-move) [359.515288] Starting subtest: fbc-2p-primscrn-spr-indfb-move [359.516953] Subtest fbc-2p-primscrn-spr-indfb-move: SKIP (0.000s) [359.602218] [019/133] (663s left) syncobj_eventfd (timeline-wait) [359.651254] Starting subtest: timeline-wait [359.661511] Subtest timeline-wait: SUCCESS (0.010s) [359.740295] [020/133] (662s left) kms_ccs (bad-rotation-90-4-tiled-dg2-mc-ccs) [359.823122] Starting subtest: bad-rotation-90-4-tiled-dg2-mc-ccs [359.823963] Starting dynamic subtest: pipe-A-eDP-1 [359.832826] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [359.840223] Starting dynamic subtest: pipe-B-eDP-1 [359.848722] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [359.855526] Starting dynamic subtest: pipe-C-eDP-1 [359.863826] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [359.870482] Starting dynamic subtest: pipe-D-eDP-1 [359.878646] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [359.880435] Subtest bad-rotation-90-4-tiled-dg2-mc-ccs: SKIP (0.005s) [362.104038] [021/133] (660s left) syncobj_wait (multi-wait-for-submit-submitted-signaled) [362.160292] Starting subtest: multi-wait-for-submit-submitted-signaled [362.161205] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.000s) [362.254496] [022/133] (660s left) gen9_exec_parse (bb-secure) [362.303603] Subtest bb-secure: SKIP (0.000s) [362.369496] [023/133] (660s left) kms_frontbuffer_tracking (fbc-1p-offscreen-pri-indfb-draw-blt) [362.457300] Starting subtest: fbc-1p-offscreen-pri-indfb-draw-blt [366.666294] Subtest fbc-1p-offscreen-pri-indfb-draw-blt: SUCCESS (4.208s) [367.817821] [024/133] (654s left) gem_ctx_persistence (process) [367.872201] Starting subtest: process [368.026464] Subtest process: SUCCESS (0.154s) [368.098269] [025/133] (654s left) kms_vrr (flipline) [368.193219] Starting subtest: flipline [368.195851] Subtest flipline: SKIP (0.000s) [368.256602] [026/133] (654s left) gem_mmap_gtt (ptrace) [368.310200] Subtest ptrace: SKIP (0.000s) [368.360771] [027/133] (654s left) kms_cursor_crc (cursor-sliding-64x21) [368.556518] Starting subtest: cursor-sliding-64x21 [368.603329] Subtest cursor-sliding-64x21: SKIP (0.046s) [368.819667] [028/133] (654s left) i915_hangman (gt-engine-hang) [368.876767] Starting subtest: gt-engine-hang [368.877831] Starting dynamic subtest: rcs0 [370.316450] Dynamic subtest rcs0: SUCCESS (1.430s) [370.326399] Starting dynamic subtest: bcs0 [372.296609] Dynamic subtest bcs0: SUCCESS (1.978s) [372.305960] Starting dynamic subtest: vcs0 [374.279795] Dynamic subtest vcs0: SUCCESS (1.980s) [374.289709] Starting dynamic subtest: vcs1 [376.328469] Dynamic subtest vcs1: SUCCESS (2.045s) [376.338415] Starting dynamic subtest: vecs0 [378.311566] Dynamic subtest vecs0: SUCCESS (1.980s) [378.321460] Starting dynamic subtest: ccs0 [380.294830] Dynamic subtest ccs0: SUCCESS (1.981s) [380.296019] Subtest gt-engine-hang: SUCCESS (11.411s) [380.372732] [029/133] (642s left) gem_workarounds (suspend-resume-context) [380.440731] Starting subtest: suspend-resume-context [396.964160] Subtest suspend-resume-context: SUCCESS (2.443s) [403.132810] [030/133] (625s left) kms_content_protection (mei-interface) [403.277863] Starting subtest: mei-interface [403.279655] Subtest mei-interface: SKIP (0.001s) [403.383543] [031/133] (625s left) perf (buffer-fill) [403.469618] Starting subtest: buffer-fill [403.470587] Starting dynamic subtest: 0-rcs0 [405.720865] Dynamic subtest 0-rcs0: SUCCESS (2.214s) [405.730772] Starting dynamic subtest: 1-vcs0 [410.154508] Dynamic subtest 1-vcs0: SUCCESS (4.393s) [410.156244] Subtest buffer-fill: SUCCESS (6.610s) [410.184800] [032/133] (618s left) kms_flip (plain-flip-fb-recreate-interruptible) [410.286093] Starting subtest: plain-flip-fb-recreate-interruptible [410.288707] Starting dynamic subtest: A-eDP1 [419.187800] Dynamic subtest A-eDP1: SUCCESS (8.864s) [419.198965] Starting dynamic subtest: B-eDP1 [428.048963] Dynamic subtest B-eDP1: SUCCESS (8.844s) [428.058921] Starting dynamic subtest: C-eDP1 [436.873901] Dynamic subtest C-eDP1: SUCCESS (8.816s) [436.883063] Starting dynamic subtest: D-eDP1 [445.705154] Dynamic subtest D-eDP1: SUCCESS (8.825s) [445.709815] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (35.362s) [446.890035] [033/133] (582s left) gem_userptr_blits (unsync-unmap-after-close) [446.941633] Subtest unsync-unmap-after-close: SKIP (0.000s) [447.059341] [034/133] (582s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt) [447.147386] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt [447.149179] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s) [447.239596] [035/133] (581s left) kms_cursor_crc (cursor-offscreen-64x64) [447.403182] Starting subtest: cursor-offscreen-64x64 [447.409797] Starting dynamic subtest: pipe-A-eDP-1 [449.342488] Dynamic subtest pipe-A-eDP-1: SUCCESS (1.932s) [449.374346] Starting dynamic subtest: pipe-D-eDP-1 [452.001966] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.633s) [452.003099] Subtest cursor-offscreen-64x64: SUCCESS (4.595s) [452.856773] [036/133] (576s left) kms_pm_rpm (modeset-non-lpsp) [454.575456] Starting subtest: modeset-non-lpsp [455.741007] Subtest modeset-non-lpsp: SKIP (1.164s) [456.115129] [037/133] (573s left) gem_eio (context-create) [456.319819] Starting subtest: context-create [456.624788] Subtest context-create: SUCCESS (0.305s) [456.730068] [038/133] (572s left) gem_busy (parallel) [456.919524] Starting subtest: parallel [456.920758] Starting dynamic subtest: rcs0 [458.407041] Dynamic subtest rcs0: SUCCESS (1.482s) [458.418503] Starting dynamic subtest: bcs0 [460.390213] Dynamic subtest bcs0: SUCCESS (1.979s) [460.401221] Starting dynamic subtest: vcs0 [462.441204] Dynamic subtest vcs0: SUCCESS (2.047s) [462.452073] Starting dynamic subtest: vcs1 [464.423376] Dynamic subtest vcs1: SUCCESS (1.978s) [464.434556] Starting dynamic subtest: vecs0 [466.406812] Dynamic subtest vecs0: SUCCESS (1.979s) [466.417894] Starting dynamic subtest: ccs0 [468.391400] Dynamic subtest ccs0: SUCCESS (1.981s) [468.392678] Subtest parallel: SUCCESS (11.463s) [468.621147] [039/133] (560s left) gem_close (many-handles-one-vma) [468.671090] Starting subtest: many-handles-one-vma [468.707999] Subtest many-handles-one-vma: SUCCESS (0.038s) [468.829482] [040/133] (560s left) gem_lmem_swapping (heavy-multi) [468.867679] Subtest heavy-multi: SKIP (0.000s) [468.909768] [041/133] (560s left) gem_exec_nop (basic-sequential) [468.968632] Starting subtest: basic-sequential [483.869457] Subtest basic-sequential: SUCCESS (14.894s) [484.084878] [042/133] (545s left) gem_exec_schedule (submit-golden-slice) [484.149696] Starting subtest: submit-golden-slice [484.150493] Starting dynamic subtest: rcs0 [484.214297] Dynamic subtest rcs0: SUCCESS (0.065s) [484.233045] Starting dynamic subtest: bcs0 [484.271447] Dynamic subtest bcs0: SUCCESS (0.056s) [484.280039] Starting dynamic subtest: vcs0 [484.331960] Dynamic subtest vcs0: SUCCESS (0.059s) [484.343441] Starting dynamic subtest: vcs1 [484.391266] Dynamic subtest vcs1: SUCCESS (0.059s) [484.406413] Starting dynamic subtest: vecs0 [484.443806] Dynamic subtest vecs0: SUCCESS (0.052s) [484.451765] Starting dynamic subtest: ccs0 [484.504688] Dynamic subtest ccs0: SUCCESS (0.060s) [484.507363] Subtest submit-golden-slice: SUCCESS (0.357s) [485.499012] [043/133] (543s left) i915_pm_rpm (system-suspend) [487.472306] Starting subtest: system-suspend [505.736946] Subtest system-suspend: SUCCESS (3.261s) [512.168820] [044/133] (523s left) kms_flip (2x-flip-vs-dpms-off-vs-modeset) [512.266541] Starting subtest: 2x-flip-vs-dpms-off-vs-modeset [512.277544] Subtest 2x-flip-vs-dpms-off-vs-modeset: SKIP (0.011s) [512.351376] [045/133] (523s left) kms_vblank (ts-continuation-modeset-rpm) [512.433962] Starting subtest: ts-continuation-modeset-rpm [512.434798] Starting dynamic subtest: pipe-A-eDP-1 [514.906741] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.471s) [514.918172] Starting dynamic subtest: pipe-D-eDP-1 [517.163699] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.251s) [517.164652] Subtest ts-continuation-modeset-rpm: SUCCESS (4.726s) [517.961362] [046/133] (517s left) kms_ccs (crc-primary-basic-yf-tiled-ccs) [518.051942] Starting subtest: crc-primary-basic-yf-tiled-ccs [518.052921] Starting dynamic subtest: pipe-A-eDP-1 [518.061642] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [518.073657] Starting dynamic subtest: pipe-B-eDP-1 [518.082784] Dynamic subtest pipe-B-eDP-1: SKIP (0.001s) [518.091454] Starting dynamic subtest: pipe-C-eDP-1 [518.100150] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [518.109345] Starting dynamic subtest: pipe-D-eDP-1 [518.117924] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [518.119556] Subtest crc-primary-basic-yf-tiled-ccs: SKIP (0.006s) [520.368556] [047/133] (515s left) syncobj_timeline (multi-wait-for-submit-signaled) [520.422437] Starting subtest: multi-wait-for-submit-signaled [520.423387] Subtest multi-wait-for-submit-signaled: SUCCESS (0.001s) [520.534705] [048/133] (515s left) syncobj_timeline (invalid-signal-one-illegal-handle) [520.590257] Starting subtest: invalid-signal-one-illegal-handle [520.591245] Subtest invalid-signal-one-illegal-handle: SUCCESS (0.000s) [520.704144] [049/133] (514s left) gem_eio (wait-1us) [520.953652] Starting subtest: wait-1us [521.325175] Subtest wait-1us: SUCCESS (0.369s) [521.480689] [050/133] (514s left) api_intel_allocator (simple-allocator) [521.531848] Starting subtest: simple-allocator [521.532724] Starting dynamic subtest: basic [521.534948] Dynamic subtest basic: SUCCESS (0.003s) [521.544506] Starting dynamic subtest: parallel-one [521.724441] Dynamic subtest parallel-one: SUCCESS (0.177s) [521.732553] Starting dynamic subtest: print [521.733517] Dynamic subtest print: SUCCESS (0.000s) [521.741707] Starting dynamic subtest: reuse [521.742533] Dynamic subtest reuse: SUCCESS (0.000s) [521.750552] Starting dynamic subtest: reserve [521.751461] Dynamic subtest reserve: SUCCESS (0.000s) [521.759637] Starting dynamic subtest: fork-reopen-allocator [521.760557] Dynamic subtest fork-reopen-allocator: SUCCESS (0.015s) [521.761576] Subtest simple-allocator: SUCCESS (0.203s) [521.881488] [051/133] (513s left) sw_sync (alloc_merge_fence) [521.913146] Starting subtest: alloc_merge_fence [521.914230] Subtest alloc_merge_fence: SUCCESS (0.000s) [521.977828] [052/133] (513s left) kms_prop_blob (blob-prop-validate) [522.030772] Starting subtest: blob-prop-validate [522.031731] Subtest blob-prop-validate: SUCCESS (0.000s) [522.139376] [053/133] (513s left) kms_hdr (static-toggle-suspend) [522.216077] Starting subtest: static-toggle-suspend [522.218678] Subtest static-toggle-suspend: SKIP (0.000s) [522.282378] [054/133] (513s left) kms_plane_scaling (invalid-parameters) [522.363956] Starting subtest: invalid-parameters [522.364807] Starting dynamic subtest: less-than-1-height-src [522.378685] Dynamic subtest less-than-1-height-src: SUCCESS (0.014s) [522.387421] Starting dynamic subtest: less-than-1-width-src [522.392291] Dynamic subtest less-than-1-width-src: SUCCESS (0.013s) [522.393235] Subtest invalid-parameters: SUCCESS (0.028s) [522.482966] [055/133] (513s left) kms_lease (setcrtc-implicit-plane) [522.564123] Starting subtest: setcrtc-implicit-plane [522.565073] Starting dynamic subtest: pipe-A-eDP-1 [523.034851] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.466s) [523.046367] Starting dynamic subtest: pipe-B-eDP-1 [524.233154] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.189s) [524.244117] Starting dynamic subtest: pipe-C-eDP-1 [525.342694] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.102s) [525.350966] Starting dynamic subtest: pipe-D-eDP-1 [526.473210] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.123s) [526.474120] Subtest setcrtc-implicit-plane: SUCCESS (3.886s) [527.312407] [056/133] (508s left) kms_feature_discovery (display-2x) [527.392986] Starting subtest: display-2x [527.394734] Subtest display-2x: SKIP (0.000s) [527.473632] [057/133] (508s left) kms_big_fb (y-tiled-8bpp-rotate-270) [527.580241] Starting subtest: y-tiled-8bpp-rotate-270 [527.582039] Subtest y-tiled-8bpp-rotate-270: SKIP (0.000s) [527.668880] [058/133] (508s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [527.763500] Starting subtest: compare-crc-sanitycheck-xr24 [527.764586] Starting dynamic subtest: pipe-A-eDP-1 [528.398966] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.633s) [528.408891] Starting dynamic subtest: pipe-B-eDP-1 [529.731085] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.325s) [529.739882] Starting dynamic subtest: pipe-C-eDP-1 [530.984875] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.249s) [530.993832] Starting dynamic subtest: pipe-D-eDP-1 [532.216558] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.227s) [532.217507] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.440s) [533.061347] [059/133] (502s left) sw_sync (sync_merge_invalid) [533.093771] Starting subtest: sync_merge_invalid [533.110228] Subtest sync_merge_invalid: SUCCESS (0.017s) [533.170938] [060/133] (502s left) kms_flip_scaled_crc (flip-64bpp-xtile-to-16bpp-xtile-downscaling) [533.258323] Starting subtest: flip-64bpp-xtile-to-16bpp-xtile-downscaling [533.259262] Starting dynamic subtest: pipe-A-default-mode [534.426337] Dynamic subtest pipe-A-default-mode: SKIP (1.165s) [534.427917] Subtest flip-64bpp-xtile-to-16bpp-xtile-downscaling: SKIP (1.166s) [534.556434] [061/133] (501s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-indfb-draw-render) [534.642858] Starting subtest: fbcpsr-1p-offscreen-pri-indfb-draw-render [541.623927] Subtest fbcpsr-1p-offscreen-pri-indfb-draw-render: SUCCESS (6.971s) [541.756253] [062/133] (494s left) kms_dirtyfb (drrs-dirtyfb-ioctl) [541.850835] Starting subtest: drrs-dirtyfb-ioctl [541.855975] Subtest drrs-dirtyfb-ioctl: SKIP (0.001s) [541.937210] [063/133] (494s left) gem_exec_flush (basic-wb-set-default) [541.997930] Starting subtest: basic-wb-set-default [547.460909] Subtest basic-wb-set-default: SUCCESS (5.458s) [547.646417] [064/133] (488s left) kms_psr2_sf (fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf) [547.747534] Starting subtest: fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf [547.748535] Starting dynamic subtest: pipe-A-eDP-1 [547.835002] Dynamic subtest pipe-A-eDP-1: SKIP (0.089s) [547.844483] Starting dynamic subtest: pipe-B-eDP-1 [549.000181] Dynamic subtest pipe-B-eDP-1: SKIP (1.163s) [549.001992] Subtest fbc-psr2-overlay-plane-move-continuous-exceed-fully-sf: SKIP (1.255s) [550.178566] [065/133] (486s left) perf_pmu (busy-idle-no-semaphores) [550.212722] Starting subtest: busy-idle-no-semaphores [550.213565] Starting dynamic subtest: rcs0 [550.865376] Dynamic subtest rcs0: SUCCESS (0.644s) [550.877093] Starting dynamic subtest: bcs0 [551.518279] Dynamic subtest bcs0: SUCCESS (0.651s) [551.530331] Starting dynamic subtest: vcs0 [552.170264] Dynamic subtest vcs0: SUCCESS (0.650s) [552.182225] Starting dynamic subtest: vcs1 [554.027754] Dynamic subtest vcs1: SUCCESS (1.855s) [554.039260] Starting dynamic subtest: vecs0 [556.010944] Dynamic subtest vecs0: SUCCESS (1.982s) [556.022824] Starting dynamic subtest: ccs0 [558.059961] Dynamic subtest ccs0: SUCCESS (2.047s) [558.061094] Subtest busy-idle-no-semaphores: SUCCESS (7.842s) [558.161701] [066/133] (478s left) kms_plane_lowres (tiling-yf) [558.254769] Starting subtest: tiling-yf [558.256492] Subtest tiling-yf: SKIP (0.000s) [558.322118] [067/133] (477s left) kms_ccs (random-ccs-data-4-tiled-dg2-mc-ccs) [558.413945] Starting subtest: random-ccs-data-4-tiled-dg2-mc-ccs [558.414782] Starting dynamic subtest: pipe-A-eDP-1 [558.424064] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [558.433495] Starting dynamic subtest: pipe-B-eDP-1 [558.443052] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [558.451661] Starting dynamic subtest: pipe-C-eDP-1 [558.460534] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [558.468983] Starting dynamic subtest: pipe-D-eDP-1 [558.477889] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [558.479462] Subtest random-ccs-data-4-tiled-dg2-mc-ccs: SKIP (0.005s) [560.646987] [068/133] (475s left) gem_exec_balancer (bonded-false-hang) [560.916250] Starting subtest: bonded-false-hang [560.918149] Subtest bonded-false-hang: SKIP (0.000s) [561.016461] [069/133] (475s left) gem_wait (invalid-flags) [561.077162] Starting subtest: invalid-flags [561.078134] Subtest invalid-flags: SUCCESS (0.000s) [561.274016] [070/133] (475s left) syncobj_timeline (etime-multi-wait-for-submit-unsubmitted-submitted) [561.322334] Starting subtest: etime-multi-wait-for-submit-unsubmitted-submitted [561.430099] Subtest etime-multi-wait-for-submit-unsubmitted-submitted: SUCCESS (0.107s) [561.514878] [071/133] (474s left) kms_flip_scaled_crc (flip-32bpp-yftile-to-64bpp-yftile-upscaling) [561.595874] Starting subtest: flip-32bpp-yftile-to-64bpp-yftile-upscaling [561.597556] Subtest flip-32bpp-yftile-to-64bpp-yftile-upscaling: SKIP (0.000s) [561.664223] [072/133] (474s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite) [561.759527] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite [561.761327] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s) [561.856941] [073/133] (474s left) kms_frontbuffer_tracking (fbc-2p-primscrn-spr-indfb-fullscreen) [561.957018] Starting subtest: fbc-2p-primscrn-spr-indfb-fullscreen [561.958686] Subtest fbc-2p-primscrn-spr-indfb-fullscreen: SKIP (0.000s) [562.034035] [074/133] (474s left) kms_scaling_modes (scaling-mode-full) [562.127808] Starting subtest: scaling-mode-full [562.128649] Starting dynamic subtest: pipe-A-eDP-1 [562.220848] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.093s) [562.233133] Starting dynamic subtest: pipe-B-eDP-1 [563.383422] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.159s) [563.402361] Starting dynamic subtest: pipe-C-eDP-1 [564.510427] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.123s) [564.521127] Starting dynamic subtest: pipe-D-eDP-1 [565.646539] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.135s) [565.647654] Subtest scaling-mode-full: SUCCESS (3.520s) [566.802740] [075/133] (469s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-indfb-draw-blt) [566.912135] Starting subtest: psr-2p-scndscrn-pri-indfb-draw-blt [566.914039] Subtest psr-2p-scndscrn-pri-indfb-draw-blt: SKIP (0.000s) [567.026261] [076/133] (469s left) kms_frontbuffer_tracking (fbcpsr-1p-pri-indfb-multidraw) [567.105905] Starting subtest: fbcpsr-1p-pri-indfb-multidraw [590.312606] Subtest fbcpsr-1p-pri-indfb-multidraw: SUCCESS (23.202s) [590.417937] [077/133] (446s left) kms_async_flips (crc-atomic) [590.515955] Starting subtest: crc-atomic [590.893619] Starting dynamic subtest: pipe-A-eDP-1 [593.845799] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.951s) [594.233629] Starting dynamic subtest: pipe-B-eDP-1 [597.182017] Dynamic subtest pipe-B-eDP-1: SUCCESS (2.956s) [597.567732] Starting dynamic subtest: pipe-C-eDP-1 [600.501687] Dynamic subtest pipe-C-eDP-1: SUCCESS (2.941s) [600.873278] Starting dynamic subtest: pipe-D-eDP-1 [603.734065] Dynamic subtest pipe-D-eDP-1: SUCCESS (2.870s) [603.734910] Subtest crc-atomic: SUCCESS (13.215s) [604.923106] [078/133] (431s left) kms_color (invalid-ctm-matrix-sizes) [605.012744] Starting subtest: invalid-ctm-matrix-sizes [605.013562] Starting dynamic subtest: pipe-A [605.014635] Dynamic subtest pipe-A: SUCCESS (0.002s) [605.023866] Starting dynamic subtest: pipe-B [605.024664] Dynamic subtest pipe-B: SUCCESS (0.003s) [605.033242] Starting dynamic subtest: pipe-C [605.034102] Dynamic subtest pipe-C: SUCCESS (0.003s) [605.042582] Starting dynamic subtest: pipe-D [605.043491] Dynamic subtest pipe-D: SUCCESS (0.004s) [605.044341] Subtest invalid-ctm-matrix-sizes: SUCCESS (0.015s) [605.104950] [079/133] (431s left) kms_ccs (crc-primary-rotation-180-yf-tiled-ccs) [605.194374] Starting subtest: crc-primary-rotation-180-yf-tiled-ccs [605.195289] Starting dynamic subtest: pipe-A-eDP-1 [605.203663] Dynamic subtest pipe-A-eDP-1: SKIP (0.000s) [605.215985] Starting dynamic subtest: pipe-B-eDP-1 [605.224611] Dynamic subtest pipe-B-eDP-1: SKIP (0.000s) [605.233266] Starting dynamic subtest: pipe-C-eDP-1 [605.241571] Dynamic subtest pipe-C-eDP-1: SKIP (0.000s) [605.250118] Starting dynamic subtest: pipe-D-eDP-1 [605.258646] Dynamic subtest pipe-D-eDP-1: SKIP (0.000s) [605.260218] Subtest crc-primary-rotation-180-yf-tiled-ccs: SKIP (0.006s) [607.469281] [080/133] (429s left) kms_frontbuffer_tracking (fbc-1p-primscrn-cur-indfb-move) [607.554697] Starting subtest: fbc-1p-primscrn-cur-indfb-move [611.650173] Subtest fbc-1p-primscrn-cur-indfb-move: SUCCESS (4.094s) [612.765951] [081/133] (424s left) gem_exec_params (mmapped) [612.826792] Starting subtest: mmapped [612.828447] Subtest mmapped: SUCCESS (0.003s) [612.941756] [082/133] (423s left) kms_frontbuffer_tracking (psr-2p-primscrn-spr-indfb-draw-pwrite) [613.030586] Starting subtest: psr-2p-primscrn-spr-indfb-draw-pwrite [613.032303] Subtest psr-2p-primscrn-spr-indfb-draw-pwrite: SKIP (0.000s) [613.146629] [083/133] (423s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-fullscreen) [613.241705] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-fullscreen [620.017233] Subtest fbcpsr-1p-primscrn-spr-indfb-fullscreen: SUCCESS (6.777s) [620.149616] [084/133] (416s left) gem_spin_batch (resubmit-new) [620.203989] Starting subtest: resubmit-new [620.205052] Starting dynamic subtest: rcs0 [620.212047] Dynamic subtest rcs0: SUCCESS (0.008s) [620.221946] Starting dynamic subtest: bcs0 [620.222858] Dynamic subtest bcs0: SUCCESS (0.004s) [620.232557] Starting dynamic subtest: vcs0 [620.233508] Dynamic subtest vcs0: SUCCESS (0.004s) [620.242807] Starting dynamic subtest: vcs1 [620.243748] Dynamic subtest vcs1: SUCCESS (0.009s) [620.252426] Starting dynamic subtest: vecs0 [620.253403] Dynamic subtest vecs0: SUCCESS (0.005s) [620.261892] Starting dynamic subtest: ccs0 [620.262767] Dynamic subtest ccs0: SUCCESS (0.008s) [620.263643] Subtest resubmit-new: SUCCESS (0.045s) [621.469125] [085/133] (415s left) kms_addfb_basic (invalid-set-prop-any) [621.533935] Starting subtest: invalid-set-prop-any [621.534951] Subtest invalid-set-prop-any: SUCCESS (0.000s) [621.649219] [086/133] (415s left) kms_big_fb (x-tiled-8bpp-rotate-180) [621.736941] Starting subtest: x-tiled-8bpp-rotate-180 [622.983643] Subtest x-tiled-8bpp-rotate-180: SUCCESS (1.247s) [623.091900] [087/133] (413s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted) [623.135507] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted [623.136743] Subtest invalid-multi-wait-all-unsubmitted-submitted: SUCCESS (0.000s) [623.230752] [088/133] (413s left) kms_psr (pr-sprite-plane-onoff) [623.313087] Starting subtest: pr-sprite-plane-onoff [623.314920] Subtest pr-sprite-plane-onoff: SKIP (0.000s) [623.395026] [089/133] (413s left) gem_ctx_isolation (preservation) [623.443789] Starting subtest: preservation [623.444679] Starting dynamic subtest: rcs0 [623.582638] Dynamic subtest rcs0: SUCCESS (0.137s) [623.595168] Starting dynamic subtest: bcs0 [623.726041] Dynamic subtest bcs0: SUCCESS (0.143s) [623.736304] Starting dynamic subtest: vcs0 [623.867566] Dynamic subtest vcs0: SUCCESS (0.141s) [623.877236] Starting dynamic subtest: vcs1 [625.479854] Dynamic subtest vcs1: SUCCESS (1.611s) [625.490059] Starting dynamic subtest: vecs0 [627.502819] Dynamic subtest vecs0: SUCCESS (2.022s) [627.514912] Starting dynamic subtest: ccs0 [629.561246] Dynamic subtest ccs0: SUCCESS (2.058s) [629.562574] Subtest preservation: SUCCESS (6.118s) [629.782530] [090/133] (407s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-render) [629.880043] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-render [629.881724] Subtest psr-2p-scndscrn-spr-indfb-draw-render: SKIP (0.000s) [629.978946] [091/133] (407s left) perf_pmu (interrupts-sync) [630.014185] Starting subtest: interrupts-sync [631.162186] Subtest interrupts-sync: SUCCESS (1.138s) [631.256113] [FACT perf_pmu (interrupts-sync)] new: kernel.kmod_is_loaded.vgem: true [631.258010] [092/133] (405s left) gem_mmap_wc (close) [631.321396] Subtest close: SKIP (0.000s) [631.389515] [093/133] (405s left) kms_psr (psr-basic) [631.477097] Starting subtest: psr-basic [631.478044] Starting dynamic subtest: eDP-1 [633.148127] Dynamic subtest eDP-1: SUCCESS (1.670s) [633.149233] Subtest psr-basic: SUCCESS (1.671s) [634.039904] [094/133] (403s left) kms_plane_scaling (plane-upscale-factor-0-25-with-modifiers) [634.137852] Starting subtest: plane-upscale-factor-0-25-with-modifiers [634.138762] Starting dynamic subtest: pipe-A [634.474422] Dynamic subtest pipe-A: SUCCESS (0.338s) [634.485070] Starting dynamic subtest: pipe-B [635.836273] Dynamic subtest pipe-B: SUCCESS (1.360s) [635.846681] Starting dynamic subtest: pipe-C [637.263117] Dynamic subtest pipe-C: SUCCESS (1.425s) [637.280928] Starting dynamic subtest: pipe-D [638.701992] Dynamic subtest pipe-D: SUCCESS (1.436s) [638.702986] Subtest plane-upscale-factor-0-25-with-modifiers: SUCCESS (4.566s) [639.881352] [095/133] (397s left) gem_render_copy (x-tiled-to-vebox-y-tiled) [639.950952] Starting subtest: x-tiled-to-vebox-y-tiled [639.952762] Subtest x-tiled-to-vebox-y-tiled: SKIP (0.000s) [640.137289] [096/133] (397s left) gem_ctx_exec (basic-close-race) [640.185982] Starting subtest: basic-close-race [646.061939] Subtest basic-close-race: SUCCESS (5.865s) [646.170136] [097/133] (391s left) kms_addfb_basic (basic-y-tiled-legacy) [646.215692] Starting subtest: basic-y-tiled-legacy [646.217623] Subtest basic-y-tiled-legacy: SKIP (0.000s) [646.347457] [098/133] (391s left) kms_psr (fbc-pr-cursor-plane-onoff) [646.437950] Starting subtest: fbc-pr-cursor-plane-onoff [646.439618] Subtest fbc-pr-cursor-plane-onoff: SKIP (0.000s) [646.507680] [099/133] (390s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-pwrite) [646.605831] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-pwrite [655.506759] Subtest psr-1p-primscrn-pri-shrfb-draw-pwrite: SUCCESS (8.901s) [655.616844] [100/133] (381s left) syncobj_wait (multi-wait-submitted-signaled) [655.675906] Starting subtest: multi-wait-submitted-signaled [655.676805] Subtest multi-wait-submitted-signaled: SUCCESS (0.000s) [655.796801] [101/133] (381s left) kms_cursor_crc (cursor-rapid-movement-256x256) [656.038332] Starting subtest: cursor-rapid-movement-256x256 [656.044526] Starting dynamic subtest: pipe-A-eDP-1 [656.603073] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.557s) [656.632515] Starting dynamic subtest: pipe-D-eDP-1 [657.842062] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.218s) [657.842990] Subtest cursor-rapid-movement-256x256: SUCCESS (1.803s) [658.689429] [102/133] (378s left) kms_big_fb (linear-16bpp-rotate-90) [658.780628] Starting subtest: linear-16bpp-rotate-90 [658.800191] Subtest linear-16bpp-rotate-90: SKIP (0.019s) [658.910933] [103/133] (378s left) gem_exec_schedule (pi-ringfull) [659.098057] Starting subtest: pi-ringfull [659.099041] Starting dynamic subtest: rcs0 [659.120796] Dynamic subtest rcs0: SUCCESS (0.031s) [659.130335] Starting dynamic subtest: bcs0 [659.152080] Dynamic subtest bcs0: SUCCESS (0.030s) [659.162626] Starting dynamic subtest: vcs0 [659.185675] Dynamic subtest vcs0: SUCCESS (0.032s) [659.199489] Starting dynamic subtest: vcs1 [659.213421] Dynamic subtest vcs1: SUCCESS (0.027s) [659.228707] Starting dynamic subtest: vecs0 [659.242373] Dynamic subtest vecs0: SUCCESS (0.028s) [659.256093] Starting dynamic subtest: ccs0 [659.270579] Dynamic subtest ccs0: SUCCESS (0.027s) [659.271438] Subtest pi-ringfull: SUCCESS (0.181s) [659.497248] [104/133] (378s left) gem_exec_params (dr4-dirt) [659.562841] Starting subtest: DR4-dirt [659.563878] Subtest DR4-dirt: SUCCESS (0.000s) [659.669821] [105/133] (377s left) sysfs_preempt_timeout (idempotent) [659.715319] Starting subtest: idempotent [659.716351] Starting dynamic subtest: vecs0 [659.717352] Dynamic subtest vecs0: SUCCESS (0.000s) [659.728038] Starting dynamic subtest: ccs0 [659.728907] Dynamic subtest ccs0: SUCCESS (0.000s) [659.737642] Starting dynamic subtest: vcs0 [659.738450] Dynamic subtest vcs0: SUCCESS (0.000s) [659.747382] Starting dynamic subtest: bcs0 [659.748402] Dynamic subtest bcs0: SUCCESS (0.000s) [659.757146] Starting dynamic subtest: rcs0 [659.758012] Dynamic subtest rcs0: SUCCESS (0.000s) [659.766616] Starting dynamic subtest: vcs1 [659.767493] Dynamic subtest vcs1: SUCCESS (0.000s) [659.768316] Subtest idempotent: SUCCESS (0.007s) [659.814001] [106/133] (377s left) kms_big_fb (4-tiled-64bpp-rotate-0) [659.907878] Starting subtest: 4-tiled-64bpp-rotate-0 [661.442338] Subtest 4-tiled-64bpp-rotate-0: SUCCESS (1.534s) [661.607249] [107/133] (376s left) api_intel_bb (render-ccs) [661.663235] Starting subtest: render-ccs [662.046493] Subtest render-ccs: SUCCESS (0.375s) [662.166673] [108/133] (375s left) gem_exec_reloc (basic-range-active) [662.228996] Subtest basic-range-active: SKIP (0.000s) [662.304147] [109/133] (375s left) gem_exec_fence (syncobj-signal) [662.747521] Starting subtest: syncobj-signal [662.752837] Subtest syncobj-signal: SUCCESS (0.005s) [664.526327] [110/133] (373s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc) [664.636602] Starting subtest: fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc [664.638462] Subtest fbcpsr-2p-scndscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s) [664.738178] [111/133] (373s left) gem_wait (busy) [664.799232] Starting subtest: busy [664.800154] Starting dynamic subtest: all-engines [666.436128] Dynamic subtest all-engines: SUCCESS (1.626s) [666.448570] Starting dynamic subtest: rcs0 [666.967956] Dynamic subtest rcs0: SUCCESS (0.539s) [666.979471] Starting dynamic subtest: bcs0 [667.508300] Dynamic subtest bcs0: SUCCESS (0.539s) [667.519771] Starting dynamic subtest: vcs0 [669.444694] Dynamic subtest vcs0: SUCCESS (1.925s) [669.455464] Starting dynamic subtest: vcs1 [671.427200] Dynamic subtest vcs1: SUCCESS (1.979s) [671.438285] Starting dynamic subtest: vecs0 [673.411445] Dynamic subtest vecs0: SUCCESS (1.980s) [673.422613] Starting dynamic subtest: ccs0 [673.945666] Dynamic subtest ccs0: SUCCESS (0.541s) [673.946906] Subtest busy: SUCCESS (9.145s) [674.141781] [112/133] (363s left) kms_chamelium_hpd (dp-hpd-with-enabled-mode) [674.542856] Subtest dp-hpd-with-enabled-mode: SKIP (0.000s) [675.308054] [113/133] (362s left) kms_chamelium_edid (dp-edid-read) [675.706578] Subtest dp-edid-read: SKIP (0.000s) [676.547989] [114/133] (361s left) gem_partial_pwrite_pread (writes-after-reads-uncached) [676.596347] Subtest writes-after-reads-uncached: SKIP (0.000s) [676.659332] [115/133] (361s left) gem_ctx_param (set-priority-not-supported) [676.712353] Starting subtest: set-priority-not-supported [676.714328] Subtest set-priority-not-supported: SKIP (0.000s) [676.785289] [116/133] (361s left) kms_big_fb (yf-tiled-max-hw-stride-32bpp-rotate-180) [676.878621] Starting subtest: yf-tiled-max-hw-stride-32bpp-rotate-180 [676.880556] Subtest yf-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [676.968058] [117/133] (361s left) gem_tiled_blits (basic) [677.017582] Subtest basic: SKIP (0.000s) [677.088321] [118/133] (361s left) kms_psr (fbc-psr2-basic) [677.180041] Starting subtest: fbc-psr2-basic [677.180915] Starting dynamic subtest: eDP-1 [677.182504] Dynamic subtest eDP-1: SKIP (0.000s) [677.184244] Subtest fbc-psr2-basic: SKIP (0.001s) [677.271938] [119/133] (360s left) kms_rotation_crc (sprite-rotation-270) [677.353068] Starting subtest: sprite-rotation-270 [677.354876] Subtest sprite-rotation-270: SKIP (0.001s) [677.422291] [120/133] (360s left) kms_frontbuffer_tracking (psr-1p-primscrn-indfb-plflip-blt) [677.513335] Starting subtest: psr-1p-primscrn-indfb-plflip-blt [685.120239] Subtest psr-1p-primscrn-indfb-plflip-blt: SUCCESS (7.606s) [685.232648] [121/133] (353s left) prime_udl [685.316411] [122/133] (352s left) kms_plane (pixel-format-4-tiled-lnl-ccs-modifier) [685.405029] Starting subtest: pixel-format-4-tiled-lnl-ccs-modifier [685.406759] Subtest pixel-format-4-tiled-lnl-ccs-modifier: SKIP (0.000s) [685.487029] [123/133] (352s left) gem_lmem_swapping (verify) [685.527954] Subtest verify: SKIP (0.000s) [685.586707] [124/133] (352s left) i915_drm_fdinfo (memory-info-shared) [685.621346] Starting subtest: memory-info-shared [685.622262] Starting dynamic subtest: smem0 [685.679105] Dynamic subtest smem0: SUCCESS (0.058s) [685.680418] Subtest memory-info-shared: SUCCESS (0.059s) [685.750842] [125/133] (352s left) kms_flip (2x-flip-vs-rmfb-interruptible) [685.841046] Starting subtest: 2x-flip-vs-rmfb-interruptible [685.852737] Subtest 2x-flip-vs-rmfb-interruptible: SKIP (0.011s) [685.952985] [126/133] (352s left) kms_properties (connector-properties-atomic) [686.033116] Starting subtest: connector-properties-atomic [686.034118] Starting dynamic subtest: pipe-A-eDP-1 [693.801021] Dynamic subtest pipe-A-eDP-1: SUCCESS (7.765s) [693.811439] Starting dynamic subtest: pipe-None-DP-1 [693.813173] Dynamic subtest pipe-None-DP-1: SUCCESS (0.001s) [693.822045] Starting dynamic subtest: pipe-None-HDMI-A-1 [693.823764] Dynamic subtest pipe-None-HDMI-A-1: SUCCESS (0.001s) [693.832889] Starting dynamic subtest: pipe-None-DP-2 [693.834510] Dynamic subtest pipe-None-DP-2: SUCCESS (0.001s) [693.843116] Starting dynamic subtest: pipe-None-HDMI-A-2 [693.844787] Dynamic subtest pipe-None-HDMI-A-2: SUCCESS (0.001s) [693.853483] Starting dynamic subtest: pipe-None-DP-3 [693.855400] Dynamic subtest pipe-None-DP-3: SUCCESS (0.001s) [693.864274] Starting dynamic subtest: pipe-None-DP-4 [693.865996] Dynamic subtest pipe-None-DP-4: SUCCESS (0.001s) [693.866877] Subtest connector-properties-atomic: SUCCESS (7.777s) [694.664912] [127/133] (343s left) gem_exec_reloc (basic-cpu-noreloc) [694.720472] Subtest basic-cpu-noreloc: SKIP (0.000s) [694.775431] [128/133] (343s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip) [694.875116] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip [695.556486] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-hflip-async-flip: SUCCESS (0.681s) [695.722947] [129/133] (342s left) gem_ringfill (basic-all) [701.381453] Starting subtest: basic-all [702.548797] Subtest basic-all: SUCCESS (1.165s) [702.657687] [130/133] (335s left) kms_big_fb (y-tiled-max-hw-stride-32bpp-rotate-180) [702.754666] Starting subtest: y-tiled-max-hw-stride-32bpp-rotate-180 [702.756509] Subtest y-tiled-max-hw-stride-32bpp-rotate-180: SKIP (0.000s) [702.854956] [131/133] (335s left) kms_chamelium_color (ctm-negative) [702.936242] Subtest ctm-negative: SKIP (0.000s) [702.980340] [132/133] (335s left) gem_softpin (softpin) [703.038808] Starting subtest: softpin [735.412618] Subtest softpin: SUCCESS (32.354s) [735.506860] [133/133] (303s left) gem_exec_suspend (basic-s3-devices) [735.557096] Starting subtest: basic-S3-devices [735.558088] Starting dynamic subtest: smem [747.396008] Dynamic subtest smem: SUCCESS (11.824s) [747.397485] Subtest basic-S3-devices: SUCCESS (11.827s) [753.578701] Closing watchdogs results: parsing output: 0/ for test: kms_rmfb results: parsing output: 1/ for test: gem_mmap_wc results: parsing output: 2/ for test: kms_selftest results: parsing output: 3/ for test: kms_pm_rpm results: parsing output: 4/ for test: i915_selftest results: parsing output: 5/ for test: gem_partial_pwrite_pread results: parsing output: 6/ for test: gem_softpin results: parsing output: 7/ for test: gem_exec_balancer results: parsing output: 8/ for test: gem_exec_store results: parsing output: 9/ for test: syncobj_timeline results: parsing output: 10/ for test: kms_psr results: parsing output: 11/ for test: kms_cursor_legacy results: parsing output: 12/ for test: gem_flink_basic results: parsing output: 13/ for test: core_setmaster results: parsing output: 14/ for test: kms_frontbuffer_tracking results: parsing output: 15/ for test: perf results: parsing output: 16/ for test: kms_frontbuffer_tracking results: parsing output: 17/ for test: kms_frontbuffer_tracking results: parsing output: 18/ for test: syncobj_eventfd results: parsing output: 19/ for test: kms_ccs results: parsing output: 20/ for test: syncobj_wait results: parsing output: 21/ for test: gen9_exec_parse results: parsing output: 22/ for test: kms_frontbuffer_tracking results: parsing output: 23/ for test: gem_ctx_persistence results: parsing output: 24/ for test: kms_vrr results: parsing output: 25/ for test: gem_mmap_gtt results: parsing output: 26/ for test: kms_cursor_crc results: parsing output: 27/ for test: i915_hangman results: parsing output: 28/ for test: gem_workarounds results: parsing output: 29/ for test: kms_content_protection results: parsing output: 30/ for test: perf results: parsing output: 31/ for test: kms_flip results: parsing output: 32/ for test: gem_userptr_blits results: parsing output: 33/ for test: kms_frontbuffer_tracking results: parsing output: 34/ for test: kms_cursor_crc results: parsing output: 35/ for test: kms_pm_rpm results: parsing output: 36/ for test: gem_eio results: parsing output: 37/ for test: gem_busy results: parsing output: 38/ for test: gem_close results: parsing output: 39/ for test: gem_lmem_swapping results: parsing output: 40/ for test: gem_exec_nop results: parsing output: 41/ for test: gem_exec_schedule results: parsing output: 42/ for test: i915_pm_rpm results: parsing output: 43/ for test: kms_flip results: parsing output: 44/ for test: kms_vblank results: parsing output: 45/ for test: kms_ccs results: parsing output: 46/ for test: syncobj_timeline results: parsing output: 47/ for test: syncobj_timeline results: parsing output: 48/ for test: gem_eio results: parsing output: 49/ for test: api_intel_allocator results: parsing output: 50/ for test: sw_sync results: parsing output: 51/ for test: kms_prop_blob results: parsing output: 52/ for test: kms_hdr results: parsing output: 53/ for test: kms_plane_scaling results: parsing output: 54/ for test: kms_lease results: parsing output: 55/ for test: kms_feature_discovery results: parsing output: 56/ for test: kms_big_fb results: parsing output: 57/ for test: kms_pipe_crc_basic results: parsing output: 58/ for test: sw_sync results: parsing output: 59/ for test: kms_flip_scaled_crc results: parsing output: 60/ for test: kms_frontbuffer_tracking results: parsing output: 61/ for test: kms_dirtyfb results: parsing output: 62/ for test: gem_exec_flush results: parsing output: 63/ for test: kms_psr2_sf results: parsing output: 64/ for test: perf_pmu results: parsing output: 65/ for test: kms_plane_lowres results: parsing output: 66/ for test: kms_ccs results: parsing output: 67/ for test: gem_exec_balancer results: parsing output: 68/ for test: gem_wait results: parsing output: 69/ for test: syncobj_timeline results: parsing output: 70/ for test: kms_flip_scaled_crc results: parsing output: 71/ for test: kms_frontbuffer_tracking results: parsing output: 72/ for test: kms_frontbuffer_tracking results: parsing output: 73/ for test: kms_scaling_modes results: parsing output: 74/ for test: kms_frontbuffer_tracking results: parsing output: 75/ for test: kms_frontbuffer_tracking results: parsing output: 76/ for test: kms_async_flips results: parsing output: 77/ for test: kms_color results: parsing output: 78/ for test: kms_ccs results: parsing output: 79/ for test: kms_frontbuffer_tracking results: parsing output: 80/ for test: gem_exec_params results: parsing output: 81/ for test: kms_frontbuffer_tracking results: parsing output: 82/ for test: kms_frontbuffer_tracking results: parsing output: 83/ for test: gem_spin_batch results: parsing output: 84/ for test: kms_addfb_basic results: parsing output: 85/ for test: kms_big_fb results: parsing output: 86/ for test: syncobj_wait results: parsing output: 87/ for test: kms_psr results: parsing output: 88/ for test: gem_ctx_isolation results: parsing output: 89/ for test: kms_frontbuffer_tracking results: parsing output: 90/ for test: perf_pmu results: parsing output: 91/ for test: gem_mmap_wc results: parsing output: 92/ for test: kms_psr results: parsing output: 93/ for test: kms_plane_scaling results: parsing output: 94/ for test: gem_render_copy results: parsing output: 95/ for test: gem_ctx_exec results: parsing output: 96/ for test: kms_addfb_basic results: parsing output: 97/ for test: kms_psr results: parsing output: 98/ for test: kms_frontbuffer_tracking results: parsing output: 99/ for test: syncobj_wait results: parsing output: 100/ for test: kms_cursor_crc results: parsing output: 101/ for test: kms_big_fb results: parsing output: 102/ for test: gem_exec_schedule results: parsing output: 103/ for test: gem_exec_params results: parsing output: 104/ for test: sysfs_preempt_timeout results: parsing output: 105/ for test: kms_big_fb results: parsing output: 106/ for test: api_intel_bb results: parsing output: 107/ for test: gem_exec_reloc results: parsing output: 108/ for test: gem_exec_fence results: parsing output: 109/ for test: kms_frontbuffer_tracking results: parsing output: 110/ for test: gem_wait results: parsing output: 111/ for test: kms_chamelium_hpd results: parsing output: 112/ for test: kms_chamelium_edid results: parsing output: 113/ for test: gem_partial_pwrite_pread results: parsing output: 114/ for test: gem_ctx_param results: parsing output: 115/ for test: kms_big_fb results: parsing output: 116/ for test: gem_tiled_blits results: parsing output: 117/ for test: kms_psr results: parsing output: 118/ for test: kms_rotation_crc results: parsing output: 119/ for test: kms_frontbuffer_tracking results: parsing output: 120/ for test: prime_udl results: parsing output: 121/ for test: kms_plane results: parsing output: 122/ for test: gem_lmem_swapping results: parsing output: 123/ for test: i915_drm_fdinfo results: parsing output: 124/ for test: kms_flip results: parsing output: 125/ for test: kms_properties results: parsing output: 126/ for test: gem_exec_reloc results: parsing output: 127/ for test: kms_big_fb results: parsing output: 128/ for test: gem_ringfill results: parsing output: 129/ for test: kms_big_fb results: parsing output: 130/ for test: kms_chamelium_color results: parsing output: 131/ for test: gem_softpin results: parsing output: 132/ for test: gem_exec_suspend Done.