[69.641197] Initializing watchdogs
[69.641280]   /dev/watchdog0
[69.672782] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:03:00.0: 8086:4905 Intel Dg1 (Gen12) DG1 [Iris Xe MAX Graphics]
[69.687566] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[69.692438] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[69.695606] [001/133] (960s left) kms_joiner (basic-force-big-joiner)
[71.197056] Starting subtest: basic-force-big-joiner
[71.200916] Subtest basic-force-big-joiner: SKIP (0.000s)
[71.367340] [002/133] (958s left) perf_pmu (busy-idle-check-all)
[71.460339] Starting subtest: busy-idle-check-all
[71.462083] Starting dynamic subtest: rcs0
[72.359929] Dynamic subtest rcs0: SUCCESS (0.898s)
[72.369620] Starting dynamic subtest: bcs0
[73.009259] Dynamic subtest bcs0: SUCCESS (0.651s)
[73.023647] Starting dynamic subtest: vcs0
[73.667275] Dynamic subtest vcs0: SUCCESS (0.657s)
[73.681531] Starting dynamic subtest: vcs1
[74.326631] Dynamic subtest vcs1: SUCCESS (0.658s)
[74.340564] Starting dynamic subtest: vecs0
[74.984293] Dynamic subtest vecs0: SUCCESS (0.656s)
[74.987032] Subtest busy-idle-check-all: SUCCESS (3.526s)
[75.130202] [003/133] (955s left) kms_ccs (bad-pixel-format-y-tiled-gen12-mc-ccs)
[76.617852] Starting subtest: bad-pixel-format-y-tiled-gen12-mc-ccs
[76.619538] Starting dynamic subtest: pipe-A-HDMI-A-1
[76.635766] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[76.645303] Starting dynamic subtest: pipe-B-HDMI-A-1
[76.662098] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[76.671725] Starting dynamic subtest: pipe-C-HDMI-A-1
[76.684196] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[76.693669] Starting dynamic subtest: pipe-D-HDMI-A-1
[76.707933] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[76.710617] Subtest bad-pixel-format-y-tiled-gen12-mc-ccs: SKIP (0.006s)
[76.855585] [004/133] (953s left) gem_softpin (evict-snoop)
[76.911106] Starting subtest: evict-snoop
[76.914026] Subtest evict-snoop: SKIP (0.000s)
[77.041977] [005/133] (953s left) kms_big_fb (4-tiled-addfb-size-offset-overflow)
[78.550927] Starting subtest: 4-tiled-addfb-size-offset-overflow
[78.554200] Subtest 4-tiled-addfb-size-offset-overflow: SKIP (0.000s)
[78.725041] [006/133] (951s left) kms_hdr (invalid-hdr)
[80.208939] Starting subtest: invalid-hdr
[80.213389] Subtest invalid-hdr: SKIP (0.001s)
[80.369194] [007/133] (950s left) kms_async_flips (test-cursor)
[81.857103] Starting subtest: test-cursor
[82.101350] Starting dynamic subtest: pipe-A-HDMI-A-1
[82.434148] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.333s)
[82.644703] Starting dynamic subtest: pipe-B-HDMI-A-1
[82.708530] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.072s)
[82.888413] Starting dynamic subtest: pipe-C-HDMI-A-1
[82.956016] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.076s)
[83.157723] Starting dynamic subtest: pipe-D-HDMI-A-1
[83.223794] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.074s)
[83.225469] Subtest test-cursor: SUCCESS (1.368s)
[83.593621] [008/133] (947s left) kms_ccs (ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc)
[85.080845] Starting subtest: ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc
[85.082220] Starting dynamic subtest: pipe-A-HDMI-A-1
[85.096103] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[85.105827] Starting dynamic subtest: pipe-B-HDMI-A-1
[85.119906] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[85.129301] Starting dynamic subtest: pipe-C-HDMI-A-1
[85.143686] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[85.152970] Starting dynamic subtest: pipe-D-HDMI-A-1
[85.168103] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[85.171121] Subtest ccs-on-another-bo-4-tiled-mtl-rc-ccs-cc: SKIP (0.005s)
[85.304409] [009/133] (945s left) gem_exec_schedule (preempt-other-chain)
[85.368168] Starting subtest: preempt-other-chain
[85.369849] Starting dynamic subtest: rcs0
[85.531268] Dynamic subtest rcs0: SUCCESS (0.160s)
[85.541299] Starting dynamic subtest: bcs0
[85.673356] Dynamic subtest bcs0: SUCCESS (0.142s)
[85.683349] Starting dynamic subtest: vcs0
[85.813366] Dynamic subtest vcs0: SUCCESS (0.140s)
[85.823670] Starting dynamic subtest: vcs1
[85.954968] Dynamic subtest vcs1: SUCCESS (0.142s)
[85.964819] Starting dynamic subtest: vecs0
[86.096644] Dynamic subtest vecs0: SUCCESS (0.141s)
[86.098109] Subtest preempt-other-chain: SUCCESS (0.726s)
[86.530664] [010/133] (944s left) kms_chamelium_edid (dp-edid-read)
[88.052437] Subtest dp-edid-read: SKIP (0.000s)
[88.160460] [011/133] (942s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[89.653194] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt
[89.656865] Subtest fbc-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[89.844409] [012/133] (941s left) kms_flip (2x-nonexisting-fb)
[91.330755] Starting subtest: 2x-nonexisting-fb
[91.352430] Subtest 2x-nonexisting-fb: SKIP (0.021s)
[91.481932] [013/133] (939s left) gen7_exec_parse (basic-allocation)
[91.534506] Subtest basic-allocation: SKIP (0.000s)
[91.608412] [014/133] (939s left) kms_psr (fbc-psr2-basic)
[93.094052] Subtest fbc-psr2-basic: SKIP (0.000s)
[93.182561] [015/133] (938s left) kms_draw_crc (draw-method-blt)
[94.680396] Starting subtest: draw-method-blt
[94.682042] Starting dynamic subtest: xrgb8888-untiled
[95.067841] Dynamic subtest xrgb8888-untiled: SUCCESS (0.387s)
[95.104668] Starting dynamic subtest: rgb565-untiled
[95.417880] Dynamic subtest rgb565-untiled: SUCCESS (0.348s)
[95.457705] Starting dynamic subtest: xrgb2101010-untiled
[95.751387] Dynamic subtest xrgb2101010-untiled: SUCCESS (0.332s)
[95.786467] Starting dynamic subtest: xbgr16161616f-untiled
[96.084623] Dynamic subtest xbgr16161616f-untiled: SUCCESS (0.332s)
[96.123817] Starting dynamic subtest: xrgb8888-xtiled
[96.270753] Dynamic subtest xrgb8888-xtiled: SUCCESS (0.184s)
[96.306709] Starting dynamic subtest: rgb565-xtiled
[96.451593] Dynamic subtest rgb565-xtiled: SUCCESS (0.179s)
[96.467259] Starting dynamic subtest: xrgb2101010-xtiled
[96.584714] Dynamic subtest xrgb2101010-xtiled: SUCCESS (0.132s)
[96.620852] Starting dynamic subtest: xbgr16161616f-xtiled
[96.751283] Dynamic subtest xbgr16161616f-xtiled: SUCCESS (0.165s)
[96.789914] Starting dynamic subtest: xrgb8888-ytiled
[96.934655] Dynamic subtest xrgb8888-ytiled: SUCCESS (0.182s)
[96.974240] Starting dynamic subtest: rgb565-ytiled
[97.117998] Dynamic subtest rgb565-ytiled: SUCCESS (0.182s)
[97.158461] Starting dynamic subtest: xrgb2101010-ytiled
[97.284582] Dynamic subtest xrgb2101010-ytiled: SUCCESS (0.165s)
[97.324117] Starting dynamic subtest: xbgr16161616f-ytiled
[97.449848] Dynamic subtest xbgr16161616f-ytiled: SUCCESS (0.165s)
[97.451631] Subtest draw-method-blt: SUCCESS (2.771s)
[97.648664] [016/133] (933s left) syncobj_wait (single-wait-for-submit-unsubmitted)
[97.696738] Starting subtest: single-wait-for-submit-unsubmitted
[97.797786] Subtest single-wait-for-submit-unsubmitted: SUCCESS (0.100s)
[97.927428] [017/133] (933s left) kms_selftest (drm_cmdline_parser)
[97.973757] Starting subtest: drm_cmdline_parser
[98.059126] Starting dynamic subtest: drm_test_cmdline_force_d_only
[98.125284] Dynamic subtest drm_test_cmdline_force_d_only: SUCCESS (0.067s)
[98.138424] Starting dynamic subtest: drm_test_cmdline_force_D_only_dvi
[98.204521] Dynamic subtest drm_test_cmdline_force_D_only_dvi: SUCCESS (0.078s)
[98.243757] Starting dynamic subtest: drm_test_cmdline_force_D_only_hdmi
[98.279594] Dynamic subtest drm_test_cmdline_force_D_only_hdmi: SUCCESS (0.074s)
[98.306121] Starting dynamic subtest: drm_test_cmdline_force_D_only_not_digital
[98.353648] Dynamic subtest drm_test_cmdline_force_D_only_not_digital: SUCCESS (0.071s)
[98.389733] Starting dynamic subtest: drm_test_cmdline_force_e_only
[98.426613] Dynamic subtest drm_test_cmdline_force_e_only: SUCCESS (0.074s)
[98.451923] Starting dynamic subtest: drm_test_cmdline_res
[98.504704] Dynamic subtest drm_test_cmdline_res: SUCCESS (0.075s)
[98.544061] Starting dynamic subtest: drm_test_cmdline_res_vesa
[98.576465] Dynamic subtest drm_test_cmdline_res_vesa: SUCCESS (0.072s)
[98.593699] Starting dynamic subtest: drm_test_cmdline_res_vesa_rblank
[98.656939] Dynamic subtest drm_test_cmdline_res_vesa_rblank: SUCCESS (0.079s)
[98.698169] Starting dynamic subtest: drm_test_cmdline_res_rblank
[98.727370] Dynamic subtest drm_test_cmdline_res_rblank: SUCCESS (0.071s)
[98.744500] Starting dynamic subtest: drm_test_cmdline_res_bpp
[98.815697] Dynamic subtest drm_test_cmdline_res_bpp: SUCCESS (0.084s)
[98.855080] Starting dynamic subtest: drm_test_cmdline_res_refresh
[98.889695] Dynamic subtest drm_test_cmdline_res_refresh: SUCCESS (0.075s)
[98.909345] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh
[98.973123] Dynamic subtest drm_test_cmdline_res_bpp_refresh: SUCCESS (0.080s)
[99.013661] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced
[99.047440] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced: SUCCESS (0.076s)
[99.067897] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_margins
[99.131941] Dynamic subtest drm_test_cmdline_res_bpp_refresh_margins: SUCCESS (0.080s)
[99.170569] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_off
[99.199540] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_off: SUCCESS (0.069s)
[99.216936] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on
[99.277745] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on: SUCCESS (0.073s)
[99.312465] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_analog
[99.343867] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_analog: SUCCESS (0.068s)
[99.360441] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_force_on_digital
[99.412319] Dynamic subtest drm_test_cmdline_res_bpp_refresh_force_on_digital: SUCCESS (0.066s)
[99.422925] Starting dynamic subtest: drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on
[99.481477] Dynamic subtest drm_test_cmdline_res_bpp_refresh_interlaced_margins_force_on: SUCCESS (0.070s)
[99.511087] Starting dynamic subtest: drm_test_cmdline_res_margins_force_on
[99.566993] Dynamic subtest drm_test_cmdline_res_margins_force_on: SUCCESS (0.081s)
[99.577585] Starting dynamic subtest: drm_test_cmdline_res_vesa_margins
[99.649114] Dynamic subtest drm_test_cmdline_res_vesa_margins: SUCCESS (0.081s)
[99.689051] Starting dynamic subtest: drm_test_cmdline_name
[99.729676] Dynamic subtest drm_test_cmdline_name: SUCCESS (0.082s)
[99.768831] Starting dynamic subtest: drm_test_cmdline_name_bpp
[99.812351] Dynamic subtest drm_test_cmdline_name_bpp: SUCCESS (0.080s)
[99.850794] Starting dynamic subtest: drm_test_cmdline_name_option
[99.890247] Dynamic subtest drm_test_cmdline_name_option: SUCCESS (0.079s)
[99.922680] Starting dynamic subtest: drm_test_cmdline_name_bpp_option
[99.970766] Dynamic subtest drm_test_cmdline_name_bpp_option: SUCCESS (0.080s)
[100.004978] Starting dynamic subtest: drm_test_cmdline_rotate_0
[100.042907] Dynamic subtest drm_test_cmdline_rotate_0: SUCCESS (0.071s)
[100.067119] Starting dynamic subtest: drm_test_cmdline_rotate_90
[100.128071] Dynamic subtest drm_test_cmdline_rotate_90: SUCCESS (0.082s)
[100.168813] Starting dynamic subtest: drm_test_cmdline_rotate_180
[100.206839] Dynamic subtest drm_test_cmdline_rotate_180: SUCCESS (0.080s)
[100.234020] Starting dynamic subtest: drm_test_cmdline_rotate_270
[100.282934] Dynamic subtest drm_test_cmdline_rotate_270: SUCCESS (0.073s)
[100.317513] Starting dynamic subtest: drm_test_cmdline_hmirror
[100.353543] Dynamic subtest drm_test_cmdline_hmirror: SUCCESS (0.071s)
[100.373962] Starting dynamic subtest: drm_test_cmdline_vmirror
[100.436692] Dynamic subtest drm_test_cmdline_vmirror: SUCCESS (0.080s)
[100.475283] Starting dynamic subtest: drm_test_cmdline_margin_options
[100.506647] Dynamic subtest drm_test_cmdline_margin_options: SUCCESS (0.070s)
[100.526235] Starting dynamic subtest: drm_test_cmdline_multiple_options
[100.582238] Dynamic subtest drm_test_cmdline_multiple_options: SUCCESS (0.074s)
[100.622853] Starting dynamic subtest: drm_test_cmdline_bpp_extra_and_option
[100.661853] Dynamic subtest drm_test_cmdline_bpp_extra_and_option: SUCCESS (0.079s)
[100.688367] Starting dynamic subtest: drm_test_cmdline_extra_and_option
[100.739214] Dynamic subtest drm_test_cmdline_extra_and_option: SUCCESS (0.074s)
[100.775393] Starting dynamic subtest: drm_test_cmdline_freestanding_options
[100.808142] Dynamic subtest drm_test_cmdline_freestanding_options: SUCCESS (0.070s)
[100.829428] Starting dynamic subtest: drm_test_cmdline_freestanding_force_e_and_options
[100.890702] Dynamic subtest drm_test_cmdline_freestanding_force_e_and_options: SUCCESS (0.079s)
[100.932709] Starting dynamic subtest: drm_test_cmdline_panel_orientation
[100.968188] Dynamic subtest drm_test_cmdline_panel_orientation: SUCCESS (0.078s)
[100.990893] Starting dynamic subtest: drm_test_cmdline_invalid
[101.096623] Dynamic subtest drm_test_cmdline_invalid: SUCCESS (0.128s)
[101.125919] Starting dynamic subtest: drm_test_cmdline_tv_options
[101.174373] Dynamic subtest drm_test_cmdline_tv_options: SUCCESS (0.076s)
[101.176561] Subtest drm_cmdline_parser: SUCCESS (3.200s)
[101.347043] [018/133] (930s left) i915_drm_fdinfo (all-busy-idle-check-all)
[101.398971] Starting subtest: all-busy-idle-check-all
[101.418993] Subtest all-busy-idle-check-all: SKIP (0.020s)
[101.533146] [019/133] (930s left) kms_frontbuffer_tracking (psr-2p-scndscrn-cur-indfb-draw-pwrite)
[103.058709] Starting subtest: psr-2p-scndscrn-cur-indfb-draw-pwrite
[103.062606] Subtest psr-2p-scndscrn-cur-indfb-draw-pwrite: SKIP (0.000s)
[103.229570] [020/133] (928s left) kms_frontbuffer_tracking (fbc-2p-rte)
[104.723562] Starting subtest: fbc-2p-rte
[104.727198] Subtest fbc-2p-rte: SKIP (0.000s)
[104.903967] [021/133] (926s left) gem_softpin (allocator-evict)
[104.955755] Starting subtest: allocator-evict
[104.957116] Starting dynamic subtest: rcs0
[133.521778] Dynamic subtest rcs0: SUCCESS (28.563s)
[133.532331] Starting dynamic subtest: bcs0
[161.694187] Dynamic subtest bcs0: SUCCESS (28.172s)
[161.705029] Starting dynamic subtest: vcs0
[190.274974] Dynamic subtest vcs0: SUCCESS (28.581s)
[190.285785] Starting dynamic subtest: vcs1
[218.759916] Dynamic subtest vcs1: SUCCESS (28.485s)
[218.770756] Starting dynamic subtest: vecs0
[247.114950] Dynamic subtest vecs0: SUCCESS (28.355s)
[247.116574] Subtest allocator-evict: SUCCESS (142.157s)
[247.266656] [022/133] (784s left) kms_big_fb (y-tiled-64bpp-rotate-180)
[248.827389] Starting subtest: y-tiled-64bpp-rotate-180
[251.165971] Subtest y-tiled-64bpp-rotate-180: SUCCESS (2.340s)
[251.358863] [023/133] (780s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite)
[252.852668] Starting subtest: fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite
[252.856201] Subtest fbcpsr-2p-primscrn-pri-shrfb-draw-pwrite: SKIP (0.000s)
[253.043896] [024/133] (779s left) i915_pm_rps (reset)
[253.101462] Starting subtest: reset
[257.814921] Subtest reset: SUCCESS (4.714s)
[257.985140] [025/133] (774s left) kms_cursor_legacy (torture-bo)
[259.471907] Starting subtest: torture-bo
[259.473278] Starting dynamic subtest: pipe-A
[265.016989] Dynamic subtest pipe-A: SUCCESS (5.542s)
[265.028686] Starting dynamic subtest: pipe-B
[270.492934] Dynamic subtest pipe-B: SUCCESS (5.479s)
[270.504905] Starting dynamic subtest: pipe-C
[275.959698] Dynamic subtest pipe-C: SUCCESS (5.466s)
[275.971611] Starting dynamic subtest: pipe-D
[281.427343] Dynamic subtest pipe-D: SUCCESS (5.467s)
[281.439316] Starting dynamic subtest: all-pipes
[286.921755] Dynamic subtest all-pipes: SUCCESS (5.495s)
[286.923259] Subtest torture-bo: SUCCESS (27.450s)
[287.079151] [026/133] (745s left) kms_plane (pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping)
[288.596992] Starting subtest: pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping
[288.632824] Starting dynamic subtest: pipe-A-plane-0
[289.183970] Dynamic subtest pipe-A-plane-0: SUCCESS (0.550s)
[289.222563] Starting dynamic subtest: pipe-A-plane-3
[289.516579] Dynamic subtest pipe-A-plane-3: SUCCESS (0.332s)
[289.551980] Starting dynamic subtest: pipe-A-plane-5
[289.866122] Dynamic subtest pipe-A-plane-5: SUCCESS (0.349s)
[290.026950] Starting dynamic subtest: pipe-B-plane-0
[290.417253] Dynamic subtest pipe-B-plane-0: SUCCESS (0.400s)
[290.450181] Starting dynamic subtest: pipe-B-plane-3
[290.767461] Dynamic subtest pipe-B-plane-3: SUCCESS (0.349s)
[290.811427] Starting dynamic subtest: pipe-B-plane-5
[291.100680] Dynamic subtest pipe-B-plane-5: SUCCESS (0.332s)
[291.190335] Subtest pixel-format-y-tiled-gen12-rc-ccs-cc-modifier-source-clamping: SUCCESS (2.593s)
[291.342662] [027/133] (741s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-downscaling)
[292.831940] Starting subtest: flip-64bpp-ytile-to-16bpp-ytile-downscaling
[292.833428] Starting dynamic subtest: pipe-A-valid-mode
[294.012111] Dynamic subtest pipe-A-valid-mode: SUCCESS (1.180s)
[294.013584] Subtest flip-64bpp-ytile-to-16bpp-ytile-downscaling: SUCCESS (1.182s)
[294.190289] [028/133] (738s left) kms_plane_scaling (planes-unity-scaling-downscale-factor-0-5)
[295.676278] Starting subtest: planes-unity-scaling-downscale-factor-0-5
[295.677834] Starting dynamic subtest: pipe-A
[295.832340] Dynamic subtest pipe-A: SUCCESS (0.156s)
[295.845378] Starting dynamic subtest: pipe-B
[295.973050] Dynamic subtest pipe-B: SUCCESS (0.140s)
[295.984425] Starting dynamic subtest: pipe-C
[296.114109] Dynamic subtest pipe-C: SUCCESS (0.140s)
[296.125793] Starting dynamic subtest: pipe-D
[296.255144] Dynamic subtest pipe-D: SUCCESS (0.140s)
[296.256669] Subtest planes-unity-scaling-downscale-factor-0-5: SUCCESS (0.579s)
[296.440807] [029/133] (736s left) api_intel_allocator (fork-simple-stress-signal)
[296.491256] Starting subtest: fork-simple-stress-signal
[301.926299] Subtest fork-simple-stress-signal: SUCCESS (5.432s)
[302.100731] [030/133] (730s left) kms_properties (plane-properties-legacy)
[303.587392] Starting subtest: plane-properties-legacy
[303.588997] Starting dynamic subtest: pipe-A-HDMI-A-1
[304.049170] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.462s)
[304.060566] Starting dynamic subtest: pipe-B-HDMI-A-1
[304.506135] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.456s)
[304.519502] Starting dynamic subtest: pipe-C-HDMI-A-1
[304.955506] Dynamic subtest pipe-C-HDMI-A-1: SUCCESS (0.447s)
[304.971873] Starting dynamic subtest: pipe-D-HDMI-A-1
[305.437645] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.471s)
[305.439122] Subtest plane-properties-legacy: SUCCESS (1.842s)
[305.594281] [031/133] (727s left) kms_flip (2x-modeset-vs-vblank-race-interruptible)
[307.086977] Starting subtest: 2x-modeset-vs-vblank-race-interruptible
[307.109748] Subtest 2x-modeset-vs-vblank-race-interruptible: SKIP (0.021s)
[307.227371] [032/133] (725s left) dmabuf_sync_file (export-wait-after-attach)
[307.383499] Starting subtest: export-wait-after-attach
[307.384881] Subtest export-wait-after-attach: SUCCESS (0.002s)
[307.479168] [FACT dmabuf_sync_file (export-wait-after-attach)] new: kernel.kmod_is_loaded.vgem: true
[307.481965] [033/133] (725s left) gem_exec_parallel (engines)
[307.539694] Starting subtest: engines
[307.541159] Starting dynamic subtest: basic
[309.128125] Dynamic subtest basic: SUCCESS (1.588s)
[309.143806] Starting dynamic subtest: contexts
[313.284263] Dynamic subtest contexts: SUCCESS (4.152s)
[313.296189] Starting dynamic subtest: fds
[317.705889] Dynamic subtest fds: SUCCESS (4.421s)
[317.717662] Starting dynamic subtest: userptr
[319.209901] Dynamic subtest userptr: SUCCESS (1.507s)
[319.211365] Subtest engines: SUCCESS (11.671s)
[319.545815] [034/133] (713s left) kms_content_protection (dp-mst-type-1)
[321.084207] Starting subtest: dp-mst-type-1
[321.087576] Subtest dp-mst-type-1: SKIP (0.000s)
[321.272521] [035/133] (711s left) gem_render_copy (yf-tiled-to-vebox-y-tiled)
[321.327892] Starting subtest: yf-tiled-to-vebox-y-tiled
[321.329246] Starting dynamic subtest: smem
[321.407791] Dynamic subtest smem: SUCCESS (0.081s)
[321.422316] Starting dynamic subtest: lmem0
[322.166761] Dynamic subtest lmem0: SUCCESS (0.755s)
[322.168208] Subtest yf-tiled-to-vebox-y-tiled: SUCCESS (0.837s)
[322.439804] [036/133] (710s left) dumb_buffer (map-valid)
[322.485897] Starting subtest: map-valid
[322.487439] Subtest map-valid: SUCCESS (0.000s)
[322.655578] [037/133] (710s left) kms_flip (flip-vs-dpms-on-nop-interruptible)
[324.145187] Starting subtest: flip-vs-dpms-on-nop-interruptible
[324.150274] Starting dynamic subtest: A-HDMI-A1
[325.143397] Dynamic subtest A-HDMI-A1: SUCCESS (0.992s)
[325.159820] Starting dynamic subtest: B-HDMI-A1
[326.103720] Dynamic subtest B-HDMI-A1: SUCCESS (0.955s)
[326.119935] Starting dynamic subtest: C-HDMI-A1
[327.063768] Dynamic subtest C-HDMI-A1: SUCCESS (0.956s)
[327.078527] Starting dynamic subtest: D-HDMI-A1
[328.007779] Dynamic subtest D-HDMI-A1: SUCCESS (0.943s)
[328.011374] Subtest flip-vs-dpms-on-nop-interruptible: SUCCESS (3.866s)
[328.247330] [038/133] (705s left) kms_ccs (bad-aux-stride-4-tiled-mtl-mc-ccs)
[329.732502] Starting subtest: bad-aux-stride-4-tiled-mtl-mc-ccs
[329.733861] Starting dynamic subtest: pipe-A-HDMI-A-1
[329.747578] Dynamic subtest pipe-A-HDMI-A-1: SKIP (0.000s)
[329.759629] Starting dynamic subtest: pipe-B-HDMI-A-1
[329.773723] Dynamic subtest pipe-B-HDMI-A-1: SKIP (0.000s)
[329.785692] Starting dynamic subtest: pipe-C-HDMI-A-1
[329.800029] Dynamic subtest pipe-C-HDMI-A-1: SKIP (0.000s)
[329.812117] Starting dynamic subtest: pipe-D-HDMI-A-1
[329.827707] Dynamic subtest pipe-D-HDMI-A-1: SKIP (0.000s)
[329.830763] Subtest bad-aux-stride-4-tiled-mtl-mc-ccs: SKIP (0.008s)
[329.977396] [039/133] (703s left) gem_ctx_param (invalid-set-no-zeromap)
[330.025641] Starting subtest: invalid-set-no-zeromap
[330.027254] Subtest invalid-set-no-zeromap: SUCCESS (0.000s)
[330.165645] [040/133] (703s left) kms_vrr (lobf)
[331.652789] Starting subtest: lobf
[331.656573] Subtest lobf: SKIP (0.000s)
[331.793873] [041/133] (701s left) kms_cursor_legacy (cursora-vs-flipb-legacy)
[333.282417] Starting subtest: cursorA-vs-flipB-legacy
[333.285465] Subtest cursorA-vs-flipB-legacy: SKIP (0.002s)
[333.418804] [042/133] (700s left) kms_vrr (flip-dpms)
[334.906435] Starting subtest: flip-dpms
[334.911158] Subtest flip-dpms: SKIP (0.000s)
[335.028933] [043/133] (698s left) gem_exec_balancer (waits)
[335.091329] Starting subtest: waits
[342.764644] Subtest waits: SUCCESS (7.670s)
[343.177503] [044/133] (690s left) kms_pm_rpm (system-suspend-modeset)
[346.995623] Starting subtest: system-suspend-modeset
[370.867862] Subtest system-suspend-modeset: SUCCESS (12.951s)
[376.828632] [045/133] (662s left) gem_exec_params (dr4-dirt)
[376.898136] Starting subtest: DR4-dirt
[376.899721] Subtest DR4-dirt: SUCCESS (0.000s)
[377.041696] [046/133] (661s left) kms_color_pipeline (plane-lut1d-pre-ctm3x4)
[378.531259] Starting subtest: plane-lut1d-pre-ctm3x4
[378.730884] Starting dynamic subtest: pipe-A-plane-0
[378.994591] Dynamic subtest pipe-A-plane-0: SUCCESS (0.264s)
[379.016280] Starting dynamic subtest: pipe-A-plane-1
[379.179374] Dynamic subtest pipe-A-plane-1: SUCCESS (0.182s)
[379.222452] Starting dynamic subtest: pipe-A-plane-2
[379.396086] Dynamic subtest pipe-A-plane-2: SUCCESS (0.212s)
[379.680536] Starting dynamic subtest: pipe-B-plane-0
[379.839079] Dynamic subtest pipe-B-plane-0: SUCCESS (0.198s)
[379.882451] Starting dynamic subtest: pipe-B-plane-1
[380.055558] Dynamic subtest pipe-B-plane-1: SUCCESS (0.212s)
[380.089111] Starting dynamic subtest: pipe-B-plane-2
[380.239781] Dynamic subtest pipe-B-plane-2: SUCCESS (0.179s)
[380.534562] Starting dynamic subtest: pipe-C-plane-0
[380.686591] Dynamic subtest pipe-C-plane-0: SUCCESS (0.166s)
[380.723590] Starting dynamic subtest: pipe-C-plane-1
[380.901564] Dynamic subtest pipe-C-plane-1: SUCCESS (0.212s)
[380.936445] Starting dynamic subtest: pipe-C-plane-2
[381.101761] Dynamic subtest pipe-C-plane-2: SUCCESS (0.195s)
[381.405287] Starting dynamic subtest: pipe-D-plane-0
[381.573865] Dynamic subtest pipe-D-plane-0: SUCCESS (0.198s)
[381.617741] Starting dynamic subtest: pipe-D-plane-1
[381.790573] Dynamic subtest pipe-D-plane-1: SUCCESS (0.212s)
[381.829966] Starting dynamic subtest: pipe-D-plane-2
[381.988636] Dynamic subtest pipe-D-plane-2: SUCCESS (0.194s)
[382.010952] Subtest plane-lut1d-pre-ctm3x4: SUCCESS (3.479s)
[382.199609] [047/133] (656s left) kms_plane_scaling (plane-downscale-factor-0-75-with-rotation)
[383.686673] Starting subtest: plane-downscale-factor-0-75-with-rotation
[383.688241] Starting dynamic subtest: pipe-A
[384.103573] Dynamic subtest pipe-A: SKIP (0.402s)
[384.117300] Starting dynamic subtest: pipe-B
[384.486691] Dynamic subtest pipe-B: SKIP (0.394s)
[384.500800] Starting dynamic subtest: pipe-C
[384.895941] Dynamic subtest pipe-C: SKIP (0.407s)
[384.910029] Starting dynamic subtest: pipe-D
[385.302385] Dynamic subtest pipe-D: SKIP (0.405s)
[385.305634] Subtest plane-downscale-factor-0-75-with-rotation: SKIP (1.613s)
[385.476800] [048/133] (653s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-draw-blt)
[386.977767] Starting subtest: psr-2p-scndscrn-spr-indfb-draw-blt
[386.980492] Subtest psr-2p-scndscrn-spr-indfb-draw-blt: SKIP (0.000s)
[387.125660] [049/133] (652s left) gem_render_copy (linear-to-vebox-yf-tiled)
[387.181435] Starting subtest: linear-to-vebox-yf-tiled
[387.182907] Starting dynamic subtest: smem
[387.263744] Dynamic subtest smem: SUCCESS (0.081s)
[387.278027] Starting dynamic subtest: lmem0
[388.020602] Dynamic subtest lmem0: SUCCESS (0.752s)
[388.022231] Subtest linear-to-vebox-yf-tiled: SUCCESS (0.837s)
[388.333012] [050/133] (650s left) kms_psr2_sf (fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf)
[389.824785] Subtest fbc-psr2-cursor-plane-move-continuous-exceed-fully-sf: SKIP (0.000s)
[389.902325] [051/133] (649s left) kms_psr (fbc-psr-sprite-blt)
[391.388443] Subtest fbc-psr-sprite-blt: SKIP (0.000s)
[391.468873] [052/133] (647s left) gem_eio (kms)
[393.098317] Starting subtest: kms
[414.505214] Subtest kms: SUCCESS (21.410s)
[414.740763] [053/133] (624s left) kms_ccs (random-ccs-data-4-tiled-bmg-ccs)
[416.227256] Starting subtest: random-ccs-data-4-tiled-bmg-ccs
[416.230604] Subtest random-ccs-data-4-tiled-bmg-ccs: SKIP (0.000s)
[416.428140] [054/133] (623s left) syncobj_wait (single-wait-all-for-submit-submitted)
[416.477678] Starting subtest: single-wait-all-for-submit-submitted
[416.582177] Subtest single-wait-all-for-submit-submitted: SUCCESS (0.103s)
[416.731032] [055/133] (622s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-upscaling)
[418.217727] Starting subtest: flip-64bpp-linear-to-16bpp-linear-upscaling
[418.219065] Starting dynamic subtest: pipe-A-valid-mode
[418.983079] Dynamic subtest pipe-A-valid-mode: SUCCESS (0.764s)
[418.984744] Subtest flip-64bpp-linear-to-16bpp-linear-upscaling: SUCCESS (0.767s)
[419.162167] [056/133] (620s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-shrfb-pgflip-blt)
[420.655214] Starting subtest: fbcpsr-2p-scndscrn-shrfb-pgflip-blt
[420.658052] Subtest fbcpsr-2p-scndscrn-shrfb-pgflip-blt: SKIP (0.000s)
[420.851309] [057/133] (619s left) syncobj_timeline (signal)
[420.900701] Starting subtest: signal
[420.902079] Subtest signal: SUCCESS (0.000s)
[421.011970] [058/133] (618s left) kms_big_fb (yf-tiled-64bpp-rotate-270)
[422.517907] Starting subtest: yf-tiled-64bpp-rotate-270
[422.521321] Subtest yf-tiled-64bpp-rotate-270: SKIP (0.000s)
[422.714766] [059/133] (617s left) gem_pread (uncached)
[422.787251] Subtest uncached: SKIP (0.000s)
[422.876369] [060/133] (617s left) kms_flip (2x-flip-vs-wf_vblank)
[424.361777] Starting subtest: 2x-flip-vs-wf_vblank
[424.384084] Subtest 2x-flip-vs-wf_vblank: SKIP (0.021s)
[424.542743] [061/133] (615s left) kms_cursor_edge_walk (128x128-right-edge)
[426.032951] Starting subtest: 128x128-right-edge
[426.034449] Starting dynamic subtest: pipe-A-HDMI-A-1
[429.339974] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (3.306s)
[429.357171] Starting dynamic subtest: pipe-D-HDMI-A-1
[432.554834] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (3.213s)
[432.556298] Subtest 128x128-right-edge: SUCCESS (6.525s)
[432.739827] [062/133] (607s left) kms_chamelium_hpd (hdmi-hpd-after-suspend)
[434.277617] Subtest hdmi-hpd-after-suspend: SKIP (0.000s)
[434.398010] [063/133] (606s left) kms_cursor_legacy (2x-nonblocking-modeset-vs-cursor-atomic)
[435.885943] Starting subtest: 2x-nonblocking-modeset-vs-cursor-atomic
[435.888882] Subtest 2x-nonblocking-modeset-vs-cursor-atomic: SKIP (0.003s)
[436.018832] [064/133] (604s left) kms_big_fb (linear-16bpp-rotate-270)
[437.527556] Starting subtest: linear-16bpp-rotate-270
[437.627240] Subtest linear-16bpp-rotate-270: SKIP (0.097s)
[437.782022] [065/133] (602s left) i915_pciid
[437.954422] [066/133] (602s left) gem_ctx_param (invalid-param-get)
[438.002128] Starting subtest: invalid-param-get
[438.003684] Subtest invalid-param-get: SUCCESS (0.001s)
[438.143933] [067/133] (602s left) kms_big_fb (linear-max-hw-stride-32bpp-rotate-0-hflip)
[439.647907] Starting subtest: linear-max-hw-stride-32bpp-rotate-0-hflip
[439.651296] Subtest linear-max-hw-stride-32bpp-rotate-0-hflip: SKIP (0.000s)
[439.823555] [068/133] (601s left) kms_big_fb (x-tiled-max-hw-stride-32bpp-rotate-0-async-flip)
[441.329449] Starting subtest: x-tiled-max-hw-stride-32bpp-rotate-0-async-flip
[441.908596] Subtest x-tiled-max-hw-stride-32bpp-rotate-0-async-flip: SUCCESS (0.580s)
[442.157193] [069/133] (598s left) kms_chamelium_color (ctm-max)
[443.643209] Subtest ctm-max: SKIP (0.000s)
[443.726849] [070/133] (597s left) kms_psr (psr2-sprite-plane-onoff)
[445.214196] Subtest psr2-sprite-plane-onoff: SKIP (0.000s)
[445.292711] [071/133] (595s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-indfb-msflip-blt)
[446.784024] Starting subtest: fbc-2p-scndscrn-indfb-msflip-blt
[446.787101] Subtest fbc-2p-scndscrn-indfb-msflip-blt: SKIP (0.000s)
[446.961978] [072/133] (594s left) gem_exec_reloc (basic-gtt-read)
[447.014697] Subtest basic-gtt-read: SKIP (0.000s)
[447.137591] [073/133] (594s left) kms_psr2_sf (pr-overlay-plane-move-continuous-exceed-sf)
[448.625579] Subtest pr-overlay-plane-move-continuous-exceed-sf: SKIP (0.000s)
[448.708206] [074/133] (592s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-fullscreen)
[450.205679] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-fullscreen
[450.208704] Subtest fbcpsr-2p-scndscrn-spr-indfb-fullscreen: SKIP (0.000s)
[450.375487] [075/133] (591s left) syncobj_timeline (multi-wait-for-submit-available-unsubmitted-signaled)
[450.424261] Starting subtest: multi-wait-for-submit-available-unsubmitted-signaled
[450.425774] Subtest multi-wait-for-submit-available-unsubmitted-signaled: SUCCESS (0.001s)
[450.553295] [076/133] (591s left) prime_self_import (basic-with_fd_dup)
[450.599824] Starting subtest: basic-with_fd_dup
[450.605040] Subtest basic-with_fd_dup: SUCCESS (0.004s)
[450.799215] [077/133] (590s left) kms_frontbuffer_tracking (fbc-2p-primscrn-pri-shrfb-draw-render)
[452.292036] Starting subtest: fbc-2p-primscrn-pri-shrfb-draw-render
[452.295146] Subtest fbc-2p-primscrn-pri-shrfb-draw-render: SKIP (0.000s)
[452.458059] [078/133] (589s left) perf_pmu (semaphore-wait)
[452.510071] Starting subtest: semaphore-wait
[452.511548] Starting dynamic subtest: rcs0
[453.044215] Dynamic subtest rcs0: SUCCESS (0.529s)
[453.059271] Starting dynamic subtest: bcs0
[453.558681] Dynamic subtest bcs0: SUCCESS (0.509s)
[453.575795] Starting dynamic subtest: vcs0
[454.073747] Dynamic subtest vcs0: SUCCESS (0.509s)
[454.091252] Starting dynamic subtest: vcs1
[454.588697] Dynamic subtest vcs1: SUCCESS (0.509s)
[454.605797] Starting dynamic subtest: vecs0
[455.103678] Dynamic subtest vecs0: SUCCESS (0.509s)
[455.105250] Subtest semaphore-wait: SUCCESS (2.594s)
[455.308562] [079/133] (586s left) gem_userptr_blits (sync-unmap)
[455.371292] Starting subtest: sync-unmap
[455.394264] Subtest sync-unmap: SUCCESS (0.022s)
[455.554503] [080/133] (586s left) gem_exec_schedule (smoketest-all)
[455.619634] Starting subtest: smoketest-all
[487.922029] Subtest smoketest-all: SUCCESS (32.291s)
[488.434301] [081/133] (553s left) syncobj_eventfd (timeline-wait)
[488.482591] Starting subtest: timeline-wait
[488.492551] Subtest timeline-wait: SUCCESS (0.011s)
[488.632293] [082/133] (553s left) gem_exec_flush (basic-wb-ro-before-default)
[488.684955] Subtest basic-wb-ro-before-default: SKIP (0.000s)
[488.792319] [083/133] (553s left) gem_exec_balancer (nop)
[488.850143] Starting subtest: nop
[528.322513] Subtest nop: SUCCESS (39.475s)
[528.743892] [084/133] (513s left) prime_mmap (test_aperture_limit)
[528.791521] Starting subtest: test_aperture_limit
[528.792809] Starting dynamic subtest: test_aperture_limit-smem
[528.814108] Dynamic subtest test_aperture_limit-smem: SKIP (0.021s)
[528.816561] Subtest test_aperture_limit: SKIP (0.022s)
[528.928018] [085/133] (513s left) syncobj_wait (invalid-signal-illegal-handle)
[528.974322] Starting subtest: invalid-signal-illegal-handle
[528.975830] Subtest invalid-signal-illegal-handle: SUCCESS (0.000s)
[529.123895] [086/133] (513s left) kms_frontbuffer_tracking (fbcpsr-farfromfence-mmap-gtt)
[530.616295] Starting subtest: fbcpsr-farfromfence-mmap-gtt
[530.620163] Subtest fbcpsr-farfromfence-mmap-gtt: SKIP (0.000s)
[530.787820] [087/133] (511s left) kms_frontbuffer_tracking (fbc-2p-primscrn-cur-indfb-draw-mmap-wc)
[532.286724] Starting subtest: fbc-2p-primscrn-cur-indfb-draw-mmap-wc
[532.290271] Subtest fbc-2p-primscrn-cur-indfb-draw-mmap-wc: SKIP (0.000s)
[532.509297] [088/133] (510s left) syncobj_timeline (etime-multi-wait-for-submit-submitted)
[532.569511] Starting subtest: etime-multi-wait-for-submit-submitted
[532.687791] Subtest etime-multi-wait-for-submit-submitted: SUCCESS (0.105s)
[532.918825] [089/133] (510s left) kms_plane_alpha_blend (alpha-basic)
[534.450023] Starting subtest: alpha-basic
[534.711131] Starting dynamic subtest: pipe-A-HDMI-A-1
[537.263150] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (2.550s)
[537.296649] Starting dynamic subtest: pipe-D-HDMI-A-1
[539.946532] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (2.663s)
[539.948075] Subtest alpha-basic: SUCCESS (5.498s)
[540.137671] [090/133] (502s left) kms_frontbuffer_tracking (psr-2p-primscrn-pri-shrfb-draw-mmap-gtt)
[541.631668] Starting subtest: psr-2p-primscrn-pri-shrfb-draw-mmap-gtt
[541.635235] Subtest psr-2p-primscrn-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[541.826927] [091/133] (501s left) kms_cursor_crc (cursor-random-max-size)
[543.656711] Starting subtest: cursor-random-max-size
[543.661692] Subtest cursor-random-max-size: SKIP (0.000s)
[543.868177] [092/133] (499s left) gem_ctx_exec (basic-close-race)
[543.919499] Starting subtest: basic-close-race
[549.493736] Subtest basic-close-race: SUCCESS (5.570s)
[549.702757] [093/133] (493s left) gem_mmap_gtt (basic-write-read-distinct)
[549.752637] Subtest basic-write-read-distinct: SKIP (0.000s)
[549.829809] [094/133] (493s left) gem_ctx_persistence (many-contexts)
[549.881821] Starting subtest: many-contexts
[588.240096] Subtest many-contexts: SUCCESS (38.358s)
[588.417330] [095/133] (455s left) kms_rotation_crc (multiplane-rotation-cropping-top)
[589.907035] Starting subtest: multiplane-rotation-cropping-top
[637.115952] Subtest multiplane-rotation-cropping-top: SUCCESS (47.211s)
[637.257070] [096/133] (406s left) kms_flip (2x-busy-flip)
[638.752831] Starting subtest: 2x-busy-flip
[638.775366] Subtest 2x-busy-flip: SKIP (0.021s)
[638.924221] [097/133] (404s left) gem_exec_create (forked)
[638.983687] Starting subtest: forked
[638.985448] Starting dynamic subtest: smem
[659.126161] Dynamic subtest smem: SUCCESS (20.142s)
[659.145649] Starting dynamic subtest: lmem0
[679.269668] Dynamic subtest lmem0: SUCCESS (20.142s)
[679.271399] Subtest forked: SUCCESS (40.287s)
[679.557592] [098/133] (364s left) gem_lmem_swapping (random)
[683.850295] Starting subtest: random
[683.851996] Starting dynamic subtest: lmem0
[685.083274] Dynamic subtest lmem0: SUCCESS (1.239s)
[685.084753] Subtest random: SUCCESS (1.240s)
[687.156665] [FACT gem_lmem_swapping (random)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[687.157826] [FACT gem_lmem_swapping (random)] deleted: kernel.kmod_is_loaded.i915: true
[687.161105] [099/133] (356s left) syncobj_wait (invalid-reset-zero-handles)
[690.527995] Starting subtest: invalid-reset-zero-handles
[690.532383] Subtest invalid-reset-zero-handles: SUCCESS (0.000s)
[690.617036] [FACT syncobj_wait (invalid-reset-zero-handles)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[690.620538] [FACT syncobj_wait (invalid-reset-zero-handles)] new: kernel.kmod_is_loaded.i915: true
[690.624872] [100/133] (353s left) kms_pm_dc (dc5-dpms-negative)
[693.157192] Starting subtest: dc5-dpms-negative
[697.385912] Subtest dc5-dpms-negative: SUCCESS (4.226s)
[697.505895] [101/133] (346s left) gem_exec_reloc (basic-cpu-wc-active)
[697.564090] Subtest basic-cpu-wc-active: SKIP (0.000s)
[697.660615] [102/133] (346s left) gem_eio (suspend)
[697.793523] Starting subtest: suspend
[710.683496] Subtest suspend: SUCCESS (12.891s)
[718.278746] [103/133] (331s left) gem_eio (wait-10ms)
[718.408096] Starting subtest: wait-10ms
[718.787152] Subtest wait-10ms: SUCCESS (0.379s)
[720.363581] [104/133] (329s left) sysfs_heartbeat_interval (nopreempt)
[720.417275] Starting subtest: nopreempt
[720.418887] Starting dynamic subtest: vecs0
[724.275184] Dynamic subtest vecs0: SUCCESS (3.855s)
[724.289575] Starting dynamic subtest: vcs0
[728.130384] Dynamic subtest vcs0: SUCCESS (3.854s)
[728.144621] Starting dynamic subtest: bcs0
[731.976511] Dynamic subtest bcs0: SUCCESS (3.845s)
[731.991018] Starting dynamic subtest: rcs0
[735.887452] Dynamic subtest rcs0: SUCCESS (3.909s)
[735.901805] Starting dynamic subtest: vcs1
[739.739217] Dynamic subtest vcs1: SUCCESS (3.850s)
[739.740560] Subtest nopreempt: SUCCESS (19.323s)
[739.935708] [105/133] (310s left) kms_frontbuffer_tracking (fbc-1p-primscrn-spr-indfb-onoff)
[741.464451] Starting subtest: fbc-1p-primscrn-spr-indfb-onoff
[744.585453] Subtest fbc-1p-primscrn-spr-indfb-onoff: SUCCESS (3.125s)
[744.849635] [106/133] (305s left) prime_vgem (basic-fence-read)
[744.910489] Starting subtest: basic-fence-read
[744.919222] Subtest basic-fence-read: SKIP (0.007s)
[745.073582] [107/133] (305s left) kms_addfb_basic (invalid-smem-bo-on-discrete)
[745.121223] Starting subtest: invalid-smem-bo-on-discrete
[745.122770] Subtest invalid-smem-bo-on-discrete: SUCCESS (0.000s)
[746.768641] [108/133] (303s left) kms_ccs (crc-primary-rotation-180-4-tiled-bmg-ccs)
[748.259683] Starting subtest: crc-primary-rotation-180-4-tiled-bmg-ccs
[748.262258] Subtest crc-primary-rotation-180-4-tiled-bmg-ccs: SKIP (0.000s)
[748.466317] [109/133] (302s left) kms_cursor_crc (cursor-dpms)
[750.019238] Starting subtest: cursor-dpms
[750.022800] Starting dynamic subtest: pipe-A-HDMI-A-1
[751.103330] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (1.081s)
[751.119732] Starting dynamic subtest: pipe-D-HDMI-A-1
[752.034138] Dynamic subtest pipe-D-HDMI-A-1: SUCCESS (0.927s)
[752.035884] Subtest cursor-dpms: SUCCESS (2.014s)
[752.639776] [110/133] (298s left) perf_pmu (interrupts-sync)
[752.689489] Starting subtest: interrupts-sync
[753.818389] Subtest interrupts-sync: SUCCESS (1.125s)
[753.975321] [111/133] (296s left) gem_exec_whisper (basic-contexts-forked)
[754.036336] Starting subtest: basic-contexts-forked
[769.782620] Subtest basic-contexts-forked: SUCCESS (15.742s)
[770.041078] [112/133] (280s left) kms_cursor_legacy (cursor-vs-flip-toggle)
[771.527043] Starting subtest: cursor-vs-flip-toggle
[807.387162] Subtest cursor-vs-flip-toggle: SUCCESS (35.861s)
[807.566310] [113/133] (243s left) syncobj_timeline (invalid-query-zero-handles)
[807.614112] Starting subtest: invalid-query-zero-handles
[807.615546] Subtest invalid-query-zero-handles: SUCCESS (0.000s)
[807.733443] [114/133] (243s left) gem_exec_schedule (u-fairslice-all)
[807.794505] Starting subtest: u-fairslice-all
[809.869821] Subtest u-fairslice-all: SUCCESS (2.075s)
[810.314211] [115/133] (240s left) kms_frontbuffer_tracking (psr-1p-primscrn-spr-indfb-draw-mmap-cpu)
[811.808248] Starting subtest: psr-1p-primscrn-spr-indfb-draw-mmap-cpu
[811.811987] Subtest psr-1p-primscrn-spr-indfb-draw-mmap-cpu: SKIP (0.000s)
[812.028125] [116/133] (239s left) gen9_exec_parse (bb-start-out)
[812.083089] Subtest bb-start-out: SKIP (0.000s)
[812.161046] [117/133] (239s left) gem_exec_fence (syncobj-import)
[812.679005] Starting subtest: syncobj-import
[812.698606] Subtest syncobj-import: SUCCESS (0.020s)
[813.165864] [118/133] (238s left) kms_psr2_su (page_flip-nv12)
[813.241326] Subtest page_flip-NV12: SKIP (0.000s)
[813.326371] [119/133] (238s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-indfb-pgflip-blt)
[814.828436] Starting subtest: fbcpsr-1p-primscrn-indfb-pgflip-blt
[814.831314] Subtest fbcpsr-1p-primscrn-indfb-pgflip-blt: SKIP (0.000s)
[815.029815] [120/133] (236s left) gem_pwrite (basic-exhaustion)
[815.080297] Subtest basic-exhaustion: SKIP (0.000s)
[815.178436] [121/133] (236s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-cur-indfb-onoff)
[816.688566] Starting subtest: fbcpsr-2p-primscrn-cur-indfb-onoff
[816.692284] Subtest fbcpsr-2p-primscrn-cur-indfb-onoff: SKIP (0.000s)
[816.852228] [122/133] (235s left) kms_frontbuffer_tracking (fbcpsr-slowdraw)
[818.348902] Starting subtest: fbcpsr-slowdraw
[818.354544] Subtest fbcpsr-slowdraw: SKIP (0.000s)
[818.579016] [123/133] (233s left) gem_eio (in-flight-suspend)
[818.771488] Starting subtest: in-flight-suspend
[862.069864] Subtest in-flight-suspend: SUCCESS (17.613s)
[868.662335] [124/133] (188s left) gem_mmap_offset (bad-extensions)
[868.709433] Starting subtest: bad-extensions
[868.711013] Subtest bad-extensions: SUCCESS (0.000s)
[868.862077] [125/133] (188s left) kms_psr (pr-primary-render)
[870.348767] Subtest pr-primary-render: SKIP (0.000s)
[870.453819] [126/133] (186s left) gem_exec_flush (basic-uc-pro-default)
[870.511778] Subtest basic-uc-pro-default: SKIP (0.000s)
[870.639358] [127/133] (186s left) kms_plane_multiple (2x-tiling-yf)
[872.126631] Starting subtest: 2x-tiling-yf
[872.129592] Subtest 2x-tiling-yf: SKIP (0.000s)
[872.275450] [128/133] (185s left) api_intel_bb (intel-bb-blit-none)
[872.325617] Starting subtest: intel-bb-blit-none
[872.993140] Subtest intel-bb-blit-none: SUCCESS (0.669s)
[873.152283] [129/133] (184s left) kms_lease (multimaster-lease)
[874.640635] Starting subtest: multimaster-lease
[874.644240] Subtest multimaster-lease: SUCCESS (0.004s)
[874.790860] [130/133] (183s left) kms_frontbuffer_tracking (psr-slowdraw)
[876.283638] Starting subtest: psr-slowdraw
[876.286504] Subtest psr-slowdraw: SKIP (0.000s)
[876.435984] [131/133] (181s left) gem_lmem_swapping (heavy-verify-random)
[880.713954] Starting subtest: heavy-verify-random
[880.716162] Starting dynamic subtest: lmem0
[897.467391] Dynamic subtest lmem0: SUCCESS (16.753s)
[897.468990] Subtest heavy-verify-random: SUCCESS (16.758s)
[898.757423] [FACT gem_lmem_swapping (heavy-verify-random)] deleted: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[898.758825] [FACT gem_lmem_swapping (heavy-verify-random)] deleted: kernel.kmod_is_loaded.i915: true
[898.762068] [132/133] (159s left) syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)
[902.043561] Starting subtest: invalid-multi-wait-unsubmitted-submitted-signaled
[902.045291] Subtest invalid-multi-wait-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[902.146733] [FACT syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)] new: hardware.pci.drm_card_at_addr.0000:03:00.0: card0
[902.150335] [FACT syncobj_wait (invalid-multi-wait-unsubmitted-submitted-signaled)] new: kernel.kmod_is_loaded.i915: true
[902.153913] [133/133] (155s left) i915_suspend (forcewake)
[902.203557] Starting subtest: forcewake
[944.229113] Subtest forcewake: SUCCESS (19.698s)
[950.386049] Closing watchdogs
results: parsing output: 0/ for test: kms_joiner
results: parsing output: 1/ for test: perf_pmu
results: parsing output: 2/ for test: kms_ccs
results: parsing output: 3/ for test: gem_softpin
results: parsing output: 4/ for test: kms_big_fb
results: parsing output: 5/ for test: kms_hdr
results: parsing output: 6/ for test: kms_async_flips
results: parsing output: 7/ for test: kms_ccs
results: parsing output: 8/ for test: gem_exec_schedule
results: parsing output: 9/ for test: kms_chamelium_edid
results: parsing output: 10/ for test: kms_frontbuffer_tracking
results: parsing output: 11/ for test: kms_flip
results: parsing output: 12/ for test: gen7_exec_parse
results: parsing output: 13/ for test: kms_psr
results: parsing output: 14/ for test: kms_draw_crc
results: parsing output: 15/ for test: syncobj_wait
results: parsing output: 16/ for test: kms_selftest
results: parsing output: 17/ for test: i915_drm_fdinfo
results: parsing output: 18/ for test: kms_frontbuffer_tracking
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: gem_softpin
results: parsing output: 21/ for test: kms_big_fb
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: i915_pm_rps
results: parsing output: 24/ for test: kms_cursor_legacy
results: parsing output: 25/ for test: kms_plane
results: parsing output: 26/ for test: kms_flip_scaled_crc
results: parsing output: 27/ for test: kms_plane_scaling
results: parsing output: 28/ for test: api_intel_allocator
results: parsing output: 29/ for test: kms_properties
results: parsing output: 30/ for test: kms_flip
results: parsing output: 31/ for test: dmabuf_sync_file
results: parsing output: 32/ for test: gem_exec_parallel
results: parsing output: 33/ for test: kms_content_protection
results: parsing output: 34/ for test: gem_render_copy
results: parsing output: 35/ for test: dumb_buffer
results: parsing output: 36/ for test: kms_flip
results: parsing output: 37/ for test: kms_ccs
results: parsing output: 38/ for test: gem_ctx_param
results: parsing output: 39/ for test: kms_vrr
results: parsing output: 40/ for test: kms_cursor_legacy
results: parsing output: 41/ for test: kms_vrr
results: parsing output: 42/ for test: gem_exec_balancer
results: parsing output: 43/ for test: kms_pm_rpm
results: parsing output: 44/ for test: gem_exec_params
results: parsing output: 45/ for test: kms_color_pipeline
results: parsing output: 46/ for test: kms_plane_scaling
results: parsing output: 47/ for test: kms_frontbuffer_tracking
results: parsing output: 48/ for test: gem_render_copy
results: parsing output: 49/ for test: kms_psr2_sf
results: parsing output: 50/ for test: kms_psr
results: parsing output: 51/ for test: gem_eio
results: parsing output: 52/ for test: kms_ccs
results: parsing output: 53/ for test: syncobj_wait
results: parsing output: 54/ for test: kms_flip_scaled_crc
results: parsing output: 55/ for test: kms_frontbuffer_tracking
results: parsing output: 56/ for test: syncobj_timeline
results: parsing output: 57/ for test: kms_big_fb
results: parsing output: 58/ for test: gem_pread
results: parsing output: 59/ for test: kms_flip
results: parsing output: 60/ for test: kms_cursor_edge_walk
results: parsing output: 61/ for test: kms_chamelium_hpd
results: parsing output: 62/ for test: kms_cursor_legacy
results: parsing output: 63/ for test: kms_big_fb
results: parsing output: 64/ for test: i915_pciid
results: parsing output: 65/ for test: gem_ctx_param
results: parsing output: 66/ for test: kms_big_fb
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: kms_chamelium_color
results: parsing output: 69/ for test: kms_psr
results: parsing output: 70/ for test: kms_frontbuffer_tracking
results: parsing output: 71/ for test: gem_exec_reloc
results: parsing output: 72/ for test: kms_psr2_sf
results: parsing output: 73/ for test: kms_frontbuffer_tracking
results: parsing output: 74/ for test: syncobj_timeline
results: parsing output: 75/ for test: prime_self_import
results: parsing output: 76/ for test: kms_frontbuffer_tracking
results: parsing output: 77/ for test: perf_pmu
results: parsing output: 78/ for test: gem_userptr_blits
results: parsing output: 79/ for test: gem_exec_schedule
results: parsing output: 80/ for test: syncobj_eventfd
results: parsing output: 81/ for test: gem_exec_flush
results: parsing output: 82/ for test: gem_exec_balancer
results: parsing output: 83/ for test: prime_mmap
results: parsing output: 84/ for test: syncobj_wait
results: parsing output: 85/ for test: kms_frontbuffer_tracking
results: parsing output: 86/ for test: kms_frontbuffer_tracking
results: parsing output: 87/ for test: syncobj_timeline
results: parsing output: 88/ for test: kms_plane_alpha_blend
results: parsing output: 89/ for test: kms_frontbuffer_tracking
results: parsing output: 90/ for test: kms_cursor_crc
results: parsing output: 91/ for test: gem_ctx_exec
results: parsing output: 92/ for test: gem_mmap_gtt
results: parsing output: 93/ for test: gem_ctx_persistence
results: parsing output: 94/ for test: kms_rotation_crc
results: parsing output: 95/ for test: kms_flip
results: parsing output: 96/ for test: gem_exec_create
results: parsing output: 97/ for test: gem_lmem_swapping
results: parsing output: 98/ for test: syncobj_wait
results: parsing output: 99/ for test: kms_pm_dc
results: parsing output: 100/ for test: gem_exec_reloc
results: parsing output: 101/ for test: gem_eio
results: parsing output: 102/ for test: gem_eio
results: parsing output: 103/ for test: sysfs_heartbeat_interval
results: parsing output: 104/ for test: kms_frontbuffer_tracking
results: parsing output: 105/ for test: prime_vgem
results: parsing output: 106/ for test: kms_addfb_basic
results: parsing output: 107/ for test: kms_ccs
results: parsing output: 108/ for test: kms_cursor_crc
results: parsing output: 109/ for test: perf_pmu
results: parsing output: 110/ for test: gem_exec_whisper
results: parsing output: 111/ for test: kms_cursor_legacy
results: parsing output: 112/ for test: syncobj_timeline
results: parsing output: 113/ for test: gem_exec_schedule
results: parsing output: 114/ for test: kms_frontbuffer_tracking
results: parsing output: 115/ for test: gen9_exec_parse
results: parsing output: 116/ for test: gem_exec_fence
results: parsing output: 117/ for test: kms_psr2_su
results: parsing output: 118/ for test: kms_frontbuffer_tracking
results: parsing output: 119/ for test: gem_pwrite
results: parsing output: 120/ for test: kms_frontbuffer_tracking
results: parsing output: 121/ for test: kms_frontbuffer_tracking
results: parsing output: 122/ for test: gem_eio
results: parsing output: 123/ for test: gem_mmap_offset
results: parsing output: 124/ for test: kms_psr
results: parsing output: 125/ for test: gem_exec_flush
results: parsing output: 126/ for test: kms_plane_multiple
results: parsing output: 127/ for test: api_intel_bb
results: parsing output: 128/ for test: kms_lease
results: parsing output: 129/ for test: kms_frontbuffer_tracking
results: parsing output: 130/ for test: gem_lmem_swapping
results: parsing output: 131/ for test: syncobj_wait
results: parsing output: 132/ for test: i915_suspend
Done.