[73.527336] Initializing watchdogs
[73.527483]   /dev/watchdog0
[73.550538] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:0102 Intel Sandybridge (Gen6) 2nd Generation Core Processor Family Integrated Graphics Controller (XPS 8300)
[73.558343] [FACT before any test] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[73.563489] [FACT before any test] new: kernel.kmod_is_loaded.i915: true
[73.567112] [001/133] (960s left) syncobj_timeline (invalid-multi-wait-unsubmitted)
[73.655661] Starting subtest: invalid-multi-wait-unsubmitted
[73.656447] Subtest invalid-multi-wait-unsubmitted: SUCCESS (0.000s)
[73.779860] [002/133] (960s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt)
[74.271245] Starting subtest: fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt
[75.745334] Subtest fbc-2p-scndscrn-pri-shrfb-draw-mmap-gtt: SUCCESS (1.475s)
[75.872169] [003/133] (958s left) kms_ccs (bad-aux-stride-y-tiled-gen12-mc-ccs)
[75.933375] Subtest bad-aux-stride-y-tiled-gen12-mc-ccs: SKIP (0.000s)
[75.981422] [004/133] (958s left) gem_mmap_gtt (basic-small-copy-odd)
[76.039796] Starting subtest: basic-small-copy-odd
[76.686452] Subtest basic-small-copy-odd: SUCCESS (0.646s)
[76.795762] [005/133] (957s left) kms_flip_scaled_crc (flip-64bpp-ytile-to-16bpp-ytile-upscaling)
[76.967910] Subtest flip-64bpp-ytile-to-16bpp-ytile-upscaling: SKIP (0.000s)
[77.015920] [006/133] (957s left) kms_big_fb (yf-tiled-32bpp-rotate-180)
[77.523349] Starting subtest: yf-tiled-32bpp-rotate-180
[77.525591] Subtest yf-tiled-32bpp-rotate-180: SKIP (0.000s)
[77.624861] [007/133] (956s left) syncobj_timeline (single-wait-available-signaled)
[77.705651] Starting subtest: single-wait-available-signaled
[77.707289] Subtest single-wait-available-signaled: SUCCESS (0.001s)
[77.801295] [008/133] (956s left) kms_cursor_legacy (flip-vs-cursor-atomic-transitions-varying-size)
[78.291156] Starting subtest: flip-vs-cursor-atomic-transitions-varying-size
[93.368695] Subtest flip-vs-cursor-atomic-transitions-varying-size: SUCCESS (15.077s)
[93.620526] [009/133] (940s left) gem_softpin (softpin)
[93.700986] Starting subtest: softpin
[125.939703] Subtest softpin: SUCCESS (32.238s)
[126.058865] [010/133] (908s left) gem_mmap_wc (read)
[126.120771] Starting subtest: read
[126.176350] Subtest read: SUCCESS (0.055s)
[126.282933] [011/133] (908s left) gem_flink_basic (basic)
[126.338630] Starting subtest: basic
[126.339448] Subtest basic: SUCCESS (0.000s)
[126.437709] [012/133] (908s left) gem_exec_params (invalid-bsd1-flag-on-render)
[126.500552] Starting subtest: invalid-bsd1-flag-on-render
[126.501370] Subtest invalid-bsd1-flag-on-render: SUCCESS (0.000s)
[126.606824] [013/133] (908s left) gem_mmap_gtt (cpuset-big-copy)
[126.665911] Starting subtest: cpuset-big-copy
[129.714441] Subtest cpuset-big-copy: SUCCESS (3.052s)
[129.938577] [014/133] (904s left) perf_pmu (busy-idle-check-all)
[130.108029] Starting subtest: busy-idle-check-all
[130.110013] Starting dynamic subtest: rcs0
[130.729532] Dynamic subtest rcs0: SUCCESS (0.621s)
[130.741899] Starting dynamic subtest: bcs0
[131.350558] Dynamic subtest bcs0: SUCCESS (0.620s)
[131.363678] Starting dynamic subtest: vcs0
[132.473710] Dynamic subtest vcs0: SUCCESS (1.122s)
[132.475260] Subtest busy-idle-check-all: SUCCESS (2.366s)
[132.566428] [015/133] (902s left) gem_render_copy_redux (flink)
[132.632998] Starting subtest: flink
[133.822012] Subtest flink: SUCCESS (1.189s)
[133.956182] [016/133] (900s left) kms_psr (fbc-psr-primary-blt)
[134.455279] Subtest fbc-psr-primary-blt: SKIP (0.000s)
[134.516971] [017/133] (900s left) kms_frontbuffer_tracking (fbc-rgb565-draw-mmap-cpu)
[135.008852] Starting subtest: fbc-rgb565-draw-mmap-cpu
[136.787040] Subtest fbc-rgb565-draw-mmap-cpu: SUCCESS (1.777s)
[137.001958] [018/133] (897s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-draw-blt)
[137.494107] Starting subtest: fbc-2p-scndscrn-spr-indfb-draw-blt
[139.146705] Subtest fbc-2p-scndscrn-spr-indfb-draw-blt: SUCCESS (1.652s)
[139.308328] [019/133] (895s left) gem_ctx_param (invalid-size-get)
[139.366442] Starting subtest: invalid-size-get
[139.367335] Subtest invalid-size-get: SUCCESS (0.000s)
[139.459734] [020/133] (895s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-spr-indfb-draw-blt)
[139.950183] Starting subtest: fbcpsr-1p-primscrn-spr-indfb-draw-blt
[139.951778] Subtest fbcpsr-1p-primscrn-spr-indfb-draw-blt: SKIP (0.000s)
[140.069503] [021/133] (894s left) kms_cursor_legacy (flip-vs-cursor-atomic)
[140.554567] Starting subtest: flip-vs-cursor-atomic
[150.548378] Subtest flip-vs-cursor-atomic: SUCCESS (9.995s)
[150.804251] [022/133] (884s left) kms_vblank (wait-busy-hang)
[151.292131] Starting subtest: wait-busy-hang
[151.294592] Starting dynamic subtest: pipe-A-VGA-1
[157.911503] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.618s)
[157.928466] Starting dynamic subtest: pipe-A-HDMI-A-1
[163.964242] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (6.050s)
[163.977610] Starting dynamic subtest: pipe-B-VGA-1
[169.938324] Dynamic subtest pipe-B-VGA-1: SUCCESS (5.974s)
[169.951501] Starting dynamic subtest: pipe-B-HDMI-A-1
[175.941601] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.003s)
[175.943200] Subtest wait-busy-hang: SUCCESS (24.652s)
[176.211930] [023/133] (858s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt)
[176.703816] Starting subtest: fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt
[176.706129] Subtest fbcpsr-2p-scndscrn-spr-indfb-draw-mmap-gtt: SKIP (0.000s)
[176.812973] [024/133] (858s left) i915_query (test-query-geometry-subslices)
[176.873712] Starting subtest: test-query-geometry-subslices
[176.875091] Subtest test-query-geometry-subslices: SKIP (0.000s)
[176.961655] [025/133] (858s left) kms_chamelium_frames (hdmi-frame-dump)
[177.551308] Subtest hdmi-frame-dump: SKIP (0.000s)
[177.763265] [026/133] (857s left) kms_cursor_legacy (nonblocking-modeset-vs-cursor-atomic)
[178.245381] Starting subtest: nonblocking-modeset-vs-cursor-atomic
[178.531924] Subtest nonblocking-modeset-vs-cursor-atomic: SUCCESS (0.286s)
[178.790170] [027/133] (856s left) kms_psr (psr-dpms)
[179.282842] Subtest psr-dpms: SKIP (0.000s)
[179.348280] [028/133] (855s left) perf (buffer-fill)
[179.551420] Subtest buffer-fill: SKIP (0.000s)
[179.625371] [029/133] (855s left) kms_feature_discovery (display)
[180.107140] Starting subtest: display
[180.108110] Subtest display: SUCCESS (0.000s)
[180.219064] [030/133] (855s left) syncobj_wait (invalid-single-wait-unsubmitted)
[180.278775] Starting subtest: invalid-single-wait-unsubmitted
[180.279527] Subtest invalid-single-wait-unsubmitted: SUCCESS (0.000s)
[180.371910] [031/133] (855s left) syncobj_timeline (multi-wait-for-submit-submitted-signaled)
[180.437842] Starting subtest: multi-wait-for-submit-submitted-signaled
[180.439493] Subtest multi-wait-for-submit-submitted-signaled: SUCCESS (0.002s)
[180.535211] [032/133] (855s left) gem_exec_reloc (basic-concurrent0)
[180.597718] Starting subtest: basic-concurrent0
[185.989498] Subtest basic-concurrent0: SUCCESS (5.392s)
[186.505268] [033/133] (849s left) core_getversion (all-cards)
[186.563943] Starting subtest: all-cards
[186.577543] Subtest all-cards: SUCCESS (0.015s)
[186.642189] [034/133] (848s left) gem_request_retire (retire-vma-not-inactive)
[186.707191] Starting subtest: retire-vma-not-inactive
[186.710956] Subtest retire-vma-not-inactive: SUCCESS (0.004s)
[186.823102] [035/133] (848s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu)
[187.312653] Starting subtest: fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu
[188.771353] Subtest fbc-2p-scndscrn-pri-indfb-draw-mmap-cpu: SUCCESS (1.458s)
[188.919685] [036/133] (846s left) gem_exec_schedule (timeslicing)
[188.994285] Subtest timeslicing: SKIP (0.000s)
[189.202228] [037/133] (846s left) kms_psr (pr-sprite-render)
[189.689539] Subtest pr-sprite-render: SKIP (0.000s)
[189.768162] [038/133] (846s left) kms_frontbuffer_tracking (basic)
[190.255918] Starting subtest: basic
[192.629835] Subtest basic: SUCCESS (2.374s)
[192.846336] [039/133] (843s left) prime_vgem (sync)
[192.974984] Starting subtest: sync
[192.975752] Starting dynamic subtest: rcs0
[192.992869] Dynamic subtest rcs0: SUCCESS (0.019s)
[193.007664] Starting dynamic subtest: bcs0
[193.010814] Dynamic subtest bcs0: SUCCESS (0.017s)
[193.012536] Subtest sync: SUCCESS (0.038s)
[193.130613] [FACT prime_vgem (sync)] new: kernel.kmod_is_loaded.vgem: true
[193.133500] [040/133] (842s left) kms_cursor_legacy (cursora-vs-flipa-atomic)
[193.623939] Starting subtest: cursorA-vs-flipA-atomic
[204.570087] Subtest cursorA-vs-flipA-atomic: SUCCESS (10.946s)
[204.835273] [041/133] (831s left) kms_frontbuffer_tracking (psr-1p-primscrn-pri-shrfb-draw-mmap-wc)
[205.346800] Starting subtest: psr-1p-primscrn-pri-shrfb-draw-mmap-wc
[205.348461] Subtest psr-1p-primscrn-pri-shrfb-draw-mmap-wc: SKIP (0.000s)
[205.466805] [042/133] (830s left) prime_vgem (basic-gtt)
[205.536710] Starting subtest: basic-gtt
[205.558724] Subtest basic-gtt: SUCCESS (0.021s)
[205.662940] [043/133] (830s left) gem_ctx_persistence (hostile)
[205.723246] Subtest hostile: SKIP (0.000s)
[205.792724] [044/133] (830s left) kms_chamelium_hpd (dp-hpd-after-suspend)
[206.381371] Subtest dp-hpd-after-suspend: SKIP (0.000s)
[206.598386] [045/133] (829s left) kms_frontbuffer_tracking (psr-1p-rte)
[207.091793] Starting subtest: psr-1p-rte
[207.092912] Subtest psr-1p-rte: SKIP (0.000s)
[207.200522] [046/133] (829s left) kms_psr (fbc-pr-primary-mmap-gtt)
[207.685851] Subtest fbc-pr-primary-mmap-gtt: SKIP (0.000s)
[207.742781] [047/133] (828s left) kms_cursor_legacy (cursorb-vs-flipb-atomic)
[208.227452] Starting subtest: cursorB-vs-flipB-atomic
[219.193823] Subtest cursorB-vs-flipB-atomic: SUCCESS (10.966s)
[219.453958] [048/133] (816s left) gem_eio (in-flight-internal-10ms)
[219.534021] Starting subtest: in-flight-internal-10ms
[219.582180] Subtest in-flight-internal-10ms: SUCCESS (0.048s)
[220.106984] [049/133] (816s left) kms_cursor_crc (cursor-offscreen-64x64)
[220.600777] Starting subtest: cursor-offscreen-64x64
[220.625379] Starting dynamic subtest: pipe-A-VGA-1
[223.082458] Dynamic subtest pipe-A-VGA-1: SUCCESS (2.456s)
[223.124201] Starting dynamic subtest: pipe-B-HDMI-A-1
[225.504966] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (2.392s)
[225.505743] Subtest cursor-offscreen-64x64: SUCCESS (4.903s)
[225.775802] [050/133] (810s left) gen7_exec_parse (oacontrol-tracking)
[225.841709] Subtest oacontrol-tracking: SKIP (0.000s)
[225.903342] [051/133] (810s left) kms_flip_scaled_crc (flip-64bpp-linear-to-16bpp-linear-downscaling)
[225.960990] Subtest flip-64bpp-linear-to-16bpp-linear-downscaling: SKIP (0.000s)
[226.018902] [052/133] (810s left) kms_pipe_crc_basic (disable-crc-after-crtc)
[226.506456] Starting subtest: disable-crc-after-crtc
[226.507330] Starting dynamic subtest: pipe-A-VGA-1
[227.048852] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.542s)
[227.063764] Starting dynamic subtest: pipe-B-HDMI-A-1
[227.627536] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.576s)
[227.628334] Subtest disable-crc-after-crtc: SUCCESS (1.122s)
[227.915107] [053/133] (808s left) kms_rotation_crc (primary-yf-tiled-reflect-x-0)
[228.406361] Starting subtest: primary-yf-tiled-reflect-x-0
[228.407880] Subtest primary-yf-tiled-reflect-x-0: SKIP (0.001s)
[228.500231] [054/133] (808s left) gem_ctx_persistence (engines-hang)
[228.562410] Subtest engines-hang: SKIP (0.000s)
[228.631449] [055/133] (808s left) gem_eio (in-flight-1us)
[228.698225] Starting subtest: in-flight-1us
[230.089168] Subtest in-flight-1us: SUCCESS (1.391s)
[230.615941] [056/133] (806s left) gem_mmap_wc (pf-nonblock)
[230.676465] Starting subtest: pf-nonblock
[230.677194] Subtest pf-nonblock: SUCCESS (0.001s)
[230.804920] [057/133] (806s left) kms_flip (plain-flip-fb-recreate-interruptible)
[231.295746] Starting subtest: plain-flip-fb-recreate-interruptible
[231.297950] Starting dynamic subtest: A-VGA1
[239.345211] Dynamic subtest A-VGA1: SUCCESS (8.048s)
[239.360719] Starting dynamic subtest: B-VGA1
[247.315309] Dynamic subtest B-VGA1: SUCCESS (7.968s)
[247.331537] Starting dynamic subtest: A-HDMI-A1
[255.326034] Dynamic subtest A-HDMI-A1: SUCCESS (8.008s)
[255.341345] Starting dynamic subtest: B-HDMI-A1
[263.361798] Dynamic subtest B-HDMI-A1: SUCCESS (8.032s)
[263.365783] Subtest plain-flip-fb-recreate-interruptible: SUCCESS (32.068s)
[263.558123] [058/133] (773s left) gem_exec_reloc (basic-wc-gtt-active)
[263.621897] Starting subtest: basic-wc-gtt-active
[263.732750] Subtest basic-wc-gtt-active: SUCCESS (0.111s)
[264.258212] [059/133] (772s left) kms_async_flips (async-flip-hang)
[264.738734] Starting subtest: async-flip-hang
[264.958352] Starting dynamic subtest: pipe-A-VGA-1
[271.854862] Dynamic subtest pipe-A-VGA-1: SUCCESS (6.897s)
[271.961727] Starting dynamic subtest: pipe-A-HDMI-A-1
[277.877960] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (5.930s)
[278.016665] Starting dynamic subtest: pipe-B-VGA-1
[283.898213] Dynamic subtest pipe-B-VGA-1: SUCCESS (5.891s)
[284.023944] Starting dynamic subtest: pipe-B-HDMI-A-1
[290.864194] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (6.853s)
[290.865071] Subtest async-flip-hang: SUCCESS (26.128s)
[291.244708] [060/133] (745s left) gem_exec_flush (basic-wb-set-default)
[291.320996] Starting subtest: basic-wb-set-default
[296.769935] Subtest basic-wb-set-default: SUCCESS (5.449s)
[296.988619] [061/133] (740s left) kms_cursor_edge_walk (128x128-top-edge)
[297.469683] Starting subtest: 128x128-top-edge
[297.470432] Starting dynamic subtest: pipe-A-VGA-1
[300.863530] Dynamic subtest pipe-A-VGA-1: SUCCESS (3.394s)
[300.878531] Starting dynamic subtest: pipe-B-HDMI-A-1
[304.195100] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.330s)
[304.195883] Subtest 128x128-top-edge: SUCCESS (6.727s)
[304.465623] [062/133] (732s left) kms_big_fb (x-tiled-8bpp-rotate-180)
[304.961788] Starting subtest: x-tiled-8bpp-rotate-180
[306.222540] Subtest x-tiled-8bpp-rotate-180: SUCCESS (1.261s)
[306.460564] [063/133] (730s left) kms_frontbuffer_tracking (psr-2p-scndscrn-spr-indfb-move)
[306.942942] Starting subtest: psr-2p-scndscrn-spr-indfb-move
[306.944641] Subtest psr-2p-scndscrn-spr-indfb-move: SKIP (0.000s)
[307.043912] [064/133] (730s left) kms_ccs (crc-primary-basic-y-tiled-gen12-mc-ccs)
[307.104398] Subtest crc-primary-basic-y-tiled-gen12-mc-ccs: SKIP (0.000s)
[307.172767] [065/133] (730s left) kms_big_fb (4-tiled-32bpp-rotate-180)
[307.657787] Starting subtest: 4-tiled-32bpp-rotate-180
[307.659776] Subtest 4-tiled-32bpp-rotate-180: SKIP (0.000s)
[307.778469] [066/133] (729s left) gem_exec_fence (syncobj-channel)
[307.990902] Starting subtest: syncobj-channel
[309.023991] Subtest syncobj-channel: SUCCESS (1.031s)
[309.371396] [067/133] (727s left) kms_mmap_write_crc (main)
[309.865032] Starting subtest: main
[309.865886] Starting dynamic subtest: pipe-A-VGA-1
[312.564460] Dynamic subtest pipe-A-VGA-1: SUCCESS (2.697s)
[312.565334] Subtest main: SUCCESS (2.699s)
[312.845687] [068/133] (724s left) kms_big_fb (y-tiled-32bpp-rotate-180)
[313.330349] Starting subtest: y-tiled-32bpp-rotate-180
[313.332165] Subtest y-tiled-32bpp-rotate-180: SKIP (0.000s)
[313.444352] [069/133] (724s left) kms_pm_rpm (fences-dpms)
[325.216780] Subtest fences-dpms: SKIP (0.000s)
[325.281672] [070/133] (712s left) gem_ctx_param (set-priority-range)
[325.348008] Subtest set-priority-range: SKIP (0.000s)
[325.443289] [071/133] (712s left) api_intel_allocator (alloc-simple)
[325.503826] Starting subtest: alloc-simple
[325.507068] Subtest alloc-simple: SUCCESS (0.005s)
[325.626611] [072/133] (712s left) gem_exec_schedule (preempt-other-chain)
[325.698268] Subtest preempt-other-chain: SKIP (0.000s)
[325.901714] [073/133] (711s left) kms_addfb_basic (too-wide)
[326.377373] Starting subtest: too-wide
[326.378170] Subtest too-wide: SUCCESS (0.000s)
[326.482599] [074/133] (711s left) gem_userptr_blits (set-cache-level)
[326.545358] Starting subtest: set-cache-level
[326.546075] Subtest set-cache-level: SUCCESS (0.000s)
[326.685857] [075/133] (711s left) kms_frontbuffer_tracking (fbcpsr-2p-primscrn-pri-indfb-draw-pwrite)
[327.168315] Starting subtest: fbcpsr-2p-primscrn-pri-indfb-draw-pwrite
[327.169998] Subtest fbcpsr-2p-primscrn-pri-indfb-draw-pwrite: SKIP (0.000s)
[327.287860] [076/133] (710s left) kms_ccs (crc-primary-suspend-4-tiled-dg2-rc-ccs-cc)
[327.346170] Subtest crc-primary-suspend-4-tiled-dg2-rc-ccs-cc: SKIP (0.000s)
[327.415722] [077/133] (710s left) kms_flip (2x-blocking-absolute-wf_vblank-interruptible)
[327.900433] Starting subtest: 2x-blocking-absolute-wf_vblank-interruptible
[327.902708] Starting dynamic subtest: AB-VGA1-HDMI-A1
[358.356340] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (30.454s)
[358.359226] Subtest 2x-blocking-absolute-wf_vblank-interruptible: SUCCESS (30.458s)
[358.621482] [078/133] (679s left) kms_plane (pixel-format-4-tiled-modifier-source-clamping)
[359.100789] Starting subtest: pixel-format-4-tiled-modifier-source-clamping
[359.102466] Subtest pixel-format-4-tiled-modifier-source-clamping: SKIP (0.000s)
[359.199586] [079/133] (678s left) gem_exec_params (rsvd2-dirt)
[359.260512] Starting subtest: rsvd2-dirt
[359.262231] Subtest rsvd2-dirt: SKIP (0.000s)
[359.376392] [080/133] (678s left) kms_ccs (crc-sprite-planes-basic-4-tiled-mtl-rc-ccs)
[359.432871] Subtest crc-sprite-planes-basic-4-tiled-mtl-rc-ccs: SKIP (0.000s)
[359.493648] [081/133] (678s left) kms_big_fb (linear-16bpp-rotate-90)
[359.979678] Starting subtest: linear-16bpp-rotate-90
[360.080325] Subtest linear-16bpp-rotate-90: SKIP (0.100s)
[360.306390] [082/133] (677s left) kms_frontbuffer_tracking (fbcpsr-1p-primscrn-cur-indfb-move)
[360.791943] Starting subtest: fbcpsr-1p-primscrn-cur-indfb-move
[360.793365] Subtest fbcpsr-1p-primscrn-cur-indfb-move: SKIP (0.000s)
[360.903632] [083/133] (677s left) kms_chamelium_audio (dp-audio)
[361.486761] Subtest dp-audio: SKIP (0.000s)
[361.721544] [084/133] (676s left) gem_bad_reloc (negative-reloc-lut)
[361.787516] Starting subtest: negative-reloc-lut
[361.789824] Subtest negative-reloc-lut: SKIP (0.000s)
[361.907540] [085/133] (676s left) kms_psr2_sf (pr-primary-plane-update-sf-dmg-area-big-fb)
[362.389797] Subtest pr-primary-plane-update-sf-dmg-area-big-fb: SKIP (0.000s)
[362.452449] [086/133] (675s left) i915_hangman (detector)
[362.524506] Starting subtest: detector
[362.525257] Starting dynamic subtest: rcs0
[366.012372] Dynamic subtest rcs0: SUCCESS (3.488s)
[366.028626] Starting dynamic subtest: bcs0
[370.043800] Dynamic subtest bcs0: SUCCESS (4.029s)
[370.059965] Starting dynamic subtest: vcs0
[374.005862] Dynamic subtest vcs0: SUCCESS (3.960s)
[374.010078] Subtest detector: SUCCESS (11.484s)
[374.093573] [087/133] (664s left) sysfs_heartbeat_interval (mixed)
[374.158021] Starting subtest: mixed
[374.158812] Starting dynamic subtest: vcs0
[374.160506] Dynamic subtest vcs0: SKIP (0.000s)
[374.175278] Starting dynamic subtest: bcs0
[374.177503] Dynamic subtest bcs0: SKIP (0.000s)
[374.192406] Starting dynamic subtest: rcs0
[374.194739] Dynamic subtest rcs0: SKIP (0.000s)
[374.197203] Subtest mixed: SKIP (0.005s)
[374.272596] [088/133] (664s left) kms_universal_plane (universal-plane-pageflip-windowed)
[374.748706] Starting subtest: universal-plane-pageflip-windowed
[374.751291] Subtest universal-plane-pageflip-windowed: SKIP (0.000s)
[374.849765] [089/133] (663s left) kms_dp_link_training (uhbr-sst)
[375.325949] Starting subtest: uhbr-sst
[375.327592] Subtest uhbr-sst: SKIP (0.000s)
[375.428242] [090/133] (663s left) gem_exec_balancer (bonded-pair)
[375.494878] Subtest bonded-pair: SKIP (0.000s)
[375.598814] [091/133] (663s left) gem_exec_fence (invalid-fence-array)
[375.805387] Starting subtest: invalid-fence-array
[375.807884] Subtest invalid-fence-array: SUCCESS (0.002s)
[376.163503] [092/133] (662s left) kms_frontbuffer_tracking (fbc-2p-scndscrn-spr-indfb-fullscreen)
[376.649985] Starting subtest: fbc-2p-scndscrn-spr-indfb-fullscreen
[377.768872] Subtest fbc-2p-scndscrn-spr-indfb-fullscreen: SUCCESS (1.120s)
[377.920757] [093/133] (660s left) kms_psr (psr-cursor-plane-onoff)
[378.400745] Subtest psr-cursor-plane-onoff: SKIP (0.000s)
[378.467521] [094/133] (660s left) kms_frontbuffer_tracking (fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt)
[378.952066] Starting subtest: fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt
[378.954325] Subtest fbcpsr-1p-offscreen-pri-shrfb-draw-mmap-gtt: SKIP (0.000s)
[379.071826] [095/133] (659s left) kms_busy (basic)
[379.552896] Starting subtest: basic
[379.555171] Starting dynamic subtest: flip
[380.045767] Dynamic subtest flip: SUCCESS (0.491s)
[380.063333] Starting dynamic subtest: modeset
[380.588294] Dynamic subtest modeset: SUCCESS (0.541s)
[380.589048] Subtest basic: SUCCESS (1.037s)
[380.848868] [096/133] (658s left) gem_exec_async (forked-writes)
[380.931054] Starting subtest: forked-writes
[380.931916] Starting dynamic subtest: rcs0
[380.946489] Dynamic subtest rcs0: SUCCESS (0.016s)
[380.963481] Starting dynamic subtest: bcs0
[380.966086] Dynamic subtest bcs0: SUCCESS (0.015s)
[380.980954] Starting dynamic subtest: vcs0
[380.987091] Dynamic subtest vcs0: SUCCESS (0.022s)
[380.989553] Subtest forked-writes: SUCCESS (0.059s)
[381.232729] [097/133] (657s left) prime_vgem (coherency-gtt)
[381.312954] Starting subtest: coherency-gtt
[381.328592] Subtest coherency-gtt: SUCCESS (0.016s)
[381.443818] [098/133] (657s left) kms_properties (colorop-properties-legacy)
[381.925809] Starting subtest: colorop-properties-legacy
[381.926744] Starting dynamic subtest: pipe-A-VGA-1
[382.094803] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.168s)
[382.113851] Starting dynamic subtest: pipe-A-HDMI-A-1
[382.331349] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.233s)
[382.348411] Starting dynamic subtest: pipe-B-VGA-1
[382.460623] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.128s)
[382.476540] Starting dynamic subtest: pipe-B-HDMI-A-1
[382.666461] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.204s)
[382.667242] Subtest colorop-properties-legacy: SUCCESS (0.742s)
[382.932646] [099/133] (656s left) gem_mmap_wc (set-cache-level)
[382.996090] Starting subtest: set-cache-level
[382.997695] Subtest set-cache-level: SUCCESS (0.001s)
[383.110877] [100/133] (656s left) kms_frontbuffer_tracking (psr-1p-offscreen-pri-indfb-draw-render)
[383.595195] Starting subtest: psr-1p-offscreen-pri-indfb-draw-render
[383.596872] Subtest psr-1p-offscreen-pri-indfb-draw-render: SKIP (0.000s)
[383.713463] [101/133] (655s left) kms_psr (fbc-psr2-primary-mmap-cpu)
[384.195213] Subtest fbc-psr2-primary-mmap-cpu: SKIP (0.000s)
[384.266898] [102/133] (655s left) syncobj_timeline (32bits-limit)
[384.329088] Starting subtest: 32bits-limit
[384.329999] Subtest 32bits-limit: SUCCESS (0.001s)
[384.431526] [103/133] (654s left) perf_pmu (busy-accuracy-98)
[384.498157] Starting subtest: busy-accuracy-98
[384.498918] Starting dynamic subtest: rcs0
[384.500407] Dynamic subtest rcs0: SKIP (0.000s)
[384.518250] Starting dynamic subtest: bcs0
[384.520672] Dynamic subtest bcs0: SKIP (0.000s)
[384.536763] Starting dynamic subtest: vcs0
[384.539045] Dynamic subtest vcs0: SKIP (0.000s)
[384.541324] Subtest busy-accuracy-98: SKIP (0.004s)
[384.601729] [104/133] (654s left) kms_plane_scaling (planes-downscale-factor-0-5-upscale-20x20)
[385.081871] Starting subtest: planes-downscale-factor-0-5-upscale-20x20
[385.082768] Starting dynamic subtest: pipe-A
[385.085828] Dynamic subtest pipe-A: SKIP (0.002s)
[385.101038] Starting dynamic subtest: pipe-B
[385.105412] Dynamic subtest pipe-B: SKIP (0.002s)
[385.107403] Subtest planes-downscale-factor-0-5-upscale-20x20: SKIP (0.007s)
[385.185802] [105/133] (654s left) gem_exec_whisper (basic-normal-all)
[385.259916] Starting subtest: basic-normal-all
[386.283060] Subtest basic-normal-all: SUCCESS (1.022s)
[386.492885] [106/133] (653s left) gem_pxp (verify-pxp-execution-after-suspend-resume)
[389.073618] Starting subtest: verify-pxp-execution-after-suspend-resume
[389.075255] Subtest verify-pxp-execution-after-suspend-resume: SKIP (0.000s)
[389.169326] [107/133] (650s left) gem_exec_reloc (basic-range-active)
[389.230873] Starting subtest: basic-range-active
[389.254019] Subtest basic-range-active: SUCCESS (0.025s)
[389.801546] [108/133] (649s left) kms_content_protection (dp-mst-type-1)
[390.301114] Starting subtest: dp-mst-type-1
[390.303582] Subtest dp-mst-type-1: SKIP (0.000s)
[390.423682] [109/133] (649s left) kms_invalid_mode (bad-htotal)
[390.900034] Starting subtest: bad-htotal
[390.903226] Starting dynamic subtest: pipe-A-VGA-1
[391.015213] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.113s)
[391.035064] Starting dynamic subtest: pipe-A-HDMI-A-1
[391.036343] Dynamic subtest pipe-A-HDMI-A-1: SUCCESS (0.001s)
[391.054570] Starting dynamic subtest: pipe-B-VGA-1
[391.055409] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.001s)
[391.073291] Starting dynamic subtest: pipe-B-HDMI-A-1
[391.074092] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (0.001s)
[391.074828] Subtest bad-htotal: SUCCESS (0.127s)
[391.304691] [110/133] (648s left) gem_userptr_blits (unsync-unmap-after-close)
[391.368083] Subtest unsync-unmap-after-close: SKIP (0.000s)
[391.510727] [111/133] (648s left) kms_frontbuffer_tracking (psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu)
[391.990672] Starting subtest: psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu
[391.991952] Subtest psr-2p-scndscrn-pri-shrfb-draw-mmap-cpu: SKIP (0.000s)
[392.104730] [112/133] (647s left) gem_exec_whisper (basic-queues-priority)
[392.181154] Starting subtest: basic-queues-priority
[392.183147] Subtest basic-queues-priority: SKIP (0.001s)
[392.388772] [113/133] (647s left) kms_flip (2x-flip-vs-suspend)
[392.861163] Starting subtest: 2x-flip-vs-suspend
[392.862234] Starting dynamic subtest: AB-VGA1-HDMI-A1
[427.311950] Dynamic subtest AB-VGA1-HDMI-A1: SUCCESS (1.843s)
[427.385897] Subtest 2x-flip-vs-suspend: SUCCESS (2.062s)
[435.656452] [114/133] (612s left) gem_ctx_engines (execute-one)
[435.750115] Starting subtest: execute-one
[436.127884] Subtest execute-one: SUCCESS (0.369s)
[436.343316] [115/133] (611s left) kms_color_pipeline (plane-ctm3x4)
[436.838217] Starting subtest: plane-ctm3x4
[437.486502] Subtest plane-ctm3x4: SKIP (0.628s)
[437.776268] [116/133] (610s left) kms_plane (plane-position-hole-dpms)
[438.265379] Starting subtest: plane-position-hole-dpms
[438.631563] Starting dynamic subtest: pipe-A-plane-1
[439.104876] Dynamic subtest pipe-A-plane-1: SUCCESS (0.461s)
[439.122098] Starting dynamic subtest: pipe-A-plane-2
[439.123708] Dynamic subtest pipe-A-plane-2: SUCCESS (0.004s)
[439.450514] Starting dynamic subtest: pipe-B-plane-1
[440.024549] Dynamic subtest pipe-B-plane-1: SUCCESS (0.577s)
[440.042923] Starting dynamic subtest: pipe-B-plane-2
[440.044206] Dynamic subtest pipe-B-plane-2: SUCCESS (0.013s)
[440.044811] Subtest plane-position-hole-dpms: SUCCESS (1.733s)
[440.311552] [117/133] (607s left) kms_plane_cursor (primary)
[440.802440] Starting subtest: primary
[440.803868] Starting dynamic subtest: pipe-A-VGA-1-size-64
[443.361812] Dynamic subtest pipe-A-VGA-1-size-64: SUCCESS (2.515s)
[443.412816] Starting dynamic subtest: pipe-A-VGA-1-size-128
[445.865617] Dynamic subtest pipe-A-VGA-1-size-128: SUCCESS (2.439s)
[445.916922] Starting dynamic subtest: pipe-A-VGA-1-size-256
[448.360897] Dynamic subtest pipe-A-VGA-1-size-256: SUCCESS (2.439s)
[448.449761] Starting dynamic subtest: pipe-B-HDMI-A-1-size-64
[450.974378] Dynamic subtest pipe-B-HDMI-A-1-size-64: SUCCESS (2.524s)
[451.025760] Starting dynamic subtest: pipe-B-HDMI-A-1-size-128
[453.464033] Dynamic subtest pipe-B-HDMI-A-1-size-128: SUCCESS (2.444s)
[453.517204] Starting dynamic subtest: pipe-B-HDMI-A-1-size-256
[455.934212] Dynamic subtest pipe-B-HDMI-A-1-size-256: SUCCESS (2.427s)
[456.052317] Subtest primary: SUCCESS (15.120s)
[456.310255] [118/133] (591s left) kms_big_fb (yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip)
[456.807108] Starting subtest: yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip
[456.809063] Subtest yf-tiled-max-hw-stride-64bpp-rotate-180-async-flip: SKIP (0.000s)
[456.933659] [119/133] (591s left) gen9_exec_parse (unaligned-access)
[456.999352] Subtest unaligned-access: SKIP (0.000s)
[457.071465] [120/133] (591s left) gem_render_copy (y-tiled-mc-ccs-to-y-tiled-ccs)
[457.143171] Starting subtest: y-tiled-mc-ccs-to-y-tiled-ccs
[457.145422] Subtest y-tiled-mc-ccs-to-y-tiled-ccs: SKIP (0.000s)
[457.360291] [121/133] (591s left) kms_cursor_crc (cursor-random-64x64)
[457.836101] Starting subtest: cursor-random-64x64
[457.854977] Starting dynamic subtest: pipe-A-VGA-1
[461.613745] Dynamic subtest pipe-A-VGA-1: SUCCESS (3.753s)
[461.660582] Starting dynamic subtest: pipe-B-HDMI-A-1
[465.336770] Dynamic subtest pipe-B-HDMI-A-1: SUCCESS (3.690s)
[465.337532] Subtest cursor-random-64x64: SUCCESS (7.492s)
[465.637219] [122/133] (582s left) dumb_buffer (create-valid-dumb)
[465.705180] Starting subtest: create-valid-dumb
[465.705977] Subtest create-valid-dumb: SUCCESS (0.000s)
[465.827947] [123/133] (582s left) syncobj_timeline (etime-multi-wait-all-submitted-signaled)
[465.890135] Starting subtest: etime-multi-wait-all-submitted-signaled
[465.992335] Subtest etime-multi-wait-all-submitted-signaled: SUCCESS (0.102s)
[466.099248] [124/133] (582s left) kms_big_fb (4-tiled-16bpp-rotate-180)
[466.588007] Starting subtest: 4-tiled-16bpp-rotate-180
[466.589573] Subtest 4-tiled-16bpp-rotate-180: SKIP (0.000s)
[466.700235] [125/133] (581s left) kms_frontbuffer_tracking (fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt)
[467.185573] Starting subtest: fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt
[467.187607] Subtest fbcpsr-2p-scndscrn-pri-indfb-draw-mmap-gtt: SKIP (0.000s)
[467.322134] [126/133] (581s left) i915_pm_rc6_residency (rc6-idle)
[467.383510] Starting subtest: rc6-idle
[467.389870] Subtest rc6-idle: SKIP (0.006s)
[467.490218] [127/133] (581s left) kms_pm_rpm (universal-planes-dpms)
[479.257709] Subtest universal-planes-dpms: SKIP (0.000s)
[479.326430] [128/133] (569s left) gem_mmap_offset (bad-object)
[479.391372] Starting subtest: bad-object
[479.393580] Subtest bad-object: SUCCESS (0.002s)
[479.511243] [129/133] (569s left) kms_frontbuffer_tracking (fbc-modesetfrombusy)
[479.998902] Starting subtest: fbc-modesetfrombusy
[480.996666] Subtest fbc-modesetfrombusy: SUCCESS (0.997s)
[481.223077] [130/133] (567s left) kms_properties (invalid-properties-legacy)
[481.702496] Starting subtest: invalid-properties-legacy
[481.713797] Subtest invalid-properties-legacy: SUCCESS (0.013s)
[481.822917] [131/133] (567s left) syncobj_wait (invalid-multi-wait-all-unsubmitted-submitted-signaled)
[481.887123] Starting subtest: invalid-multi-wait-all-unsubmitted-submitted-signaled
[481.887795] Subtest invalid-multi-wait-all-unsubmitted-submitted-signaled: SUCCESS (0.000s)
[481.997041] [132/133] (566s left) gem_softpin (evict-single-offset)
[482.056401] Subtest evict-single-offset: SKIP (0.000s)
[482.155276] [133/133] (566s left) kms_frontbuffer_tracking (psr-2p-primscrn-shrfb-pgflip-blt)
[482.634792] Starting subtest: psr-2p-primscrn-shrfb-pgflip-blt
[482.636696] Subtest psr-2p-primscrn-shrfb-pgflip-blt: SKIP (0.000s)
[482.757976] Closing watchdogs
results: parsing output: 0/ for test: syncobj_timeline
results: parsing output: 1/ for test: kms_frontbuffer_tracking
results: parsing output: 2/ for test: kms_ccs
results: parsing output: 3/ for test: gem_mmap_gtt
results: parsing output: 4/ for test: kms_flip_scaled_crc
results: parsing output: 5/ for test: kms_big_fb
results: parsing output: 6/ for test: syncobj_timeline
results: parsing output: 7/ for test: kms_cursor_legacy
results: parsing output: 8/ for test: gem_softpin
results: parsing output: 9/ for test: gem_mmap_wc
results: parsing output: 10/ for test: gem_flink_basic
results: parsing output: 11/ for test: gem_exec_params
results: parsing output: 12/ for test: gem_mmap_gtt
results: parsing output: 13/ for test: perf_pmu
results: parsing output: 14/ for test: gem_render_copy_redux
results: parsing output: 15/ for test: kms_psr
results: parsing output: 16/ for test: kms_frontbuffer_tracking
results: parsing output: 17/ for test: kms_frontbuffer_tracking
results: parsing output: 18/ for test: gem_ctx_param
results: parsing output: 19/ for test: kms_frontbuffer_tracking
results: parsing output: 20/ for test: kms_cursor_legacy
results: parsing output: 21/ for test: kms_vblank
results: parsing output: 22/ for test: kms_frontbuffer_tracking
results: parsing output: 23/ for test: i915_query
results: parsing output: 24/ for test: kms_chamelium_frames
results: parsing output: 25/ for test: kms_cursor_legacy
results: parsing output: 26/ for test: kms_psr
results: parsing output: 27/ for test: perf
results: parsing output: 28/ for test: kms_feature_discovery
results: parsing output: 29/ for test: syncobj_wait
results: parsing output: 30/ for test: syncobj_timeline
results: parsing output: 31/ for test: gem_exec_reloc
results: parsing output: 32/ for test: core_getversion
results: parsing output: 33/ for test: gem_request_retire
results: parsing output: 34/ for test: kms_frontbuffer_tracking
results: parsing output: 35/ for test: gem_exec_schedule
results: parsing output: 36/ for test: kms_psr
results: parsing output: 37/ for test: kms_frontbuffer_tracking
results: parsing output: 38/ for test: prime_vgem
results: parsing output: 39/ for test: kms_cursor_legacy
results: parsing output: 40/ for test: kms_frontbuffer_tracking
results: parsing output: 41/ for test: prime_vgem
results: parsing output: 42/ for test: gem_ctx_persistence
results: parsing output: 43/ for test: kms_chamelium_hpd
results: parsing output: 44/ for test: kms_frontbuffer_tracking
results: parsing output: 45/ for test: kms_psr
results: parsing output: 46/ for test: kms_cursor_legacy
results: parsing output: 47/ for test: gem_eio
results: parsing output: 48/ for test: kms_cursor_crc
results: parsing output: 49/ for test: gen7_exec_parse
results: parsing output: 50/ for test: kms_flip_scaled_crc
results: parsing output: 51/ for test: kms_pipe_crc_basic
results: parsing output: 52/ for test: kms_rotation_crc
results: parsing output: 53/ for test: gem_ctx_persistence
results: parsing output: 54/ for test: gem_eio
results: parsing output: 55/ for test: gem_mmap_wc
results: parsing output: 56/ for test: kms_flip
results: parsing output: 57/ for test: gem_exec_reloc
results: parsing output: 58/ for test: kms_async_flips
results: parsing output: 59/ for test: gem_exec_flush
results: parsing output: 60/ for test: kms_cursor_edge_walk
results: parsing output: 61/ for test: kms_big_fb
results: parsing output: 62/ for test: kms_frontbuffer_tracking
results: parsing output: 63/ for test: kms_ccs
results: parsing output: 64/ for test: kms_big_fb
results: parsing output: 65/ for test: gem_exec_fence
results: parsing output: 66/ for test: kms_mmap_write_crc
results: parsing output: 67/ for test: kms_big_fb
results: parsing output: 68/ for test: kms_pm_rpm
results: parsing output: 69/ for test: gem_ctx_param
results: parsing output: 70/ for test: api_intel_allocator
results: parsing output: 71/ for test: gem_exec_schedule
results: parsing output: 72/ for test: kms_addfb_basic
results: parsing output: 73/ for test: gem_userptr_blits
results: parsing output: 74/ for test: kms_frontbuffer_tracking
results: parsing output: 75/ for test: kms_ccs
results: parsing output: 76/ for test: kms_flip
results: parsing output: 77/ for test: kms_plane
results: parsing output: 78/ for test: gem_exec_params
results: parsing output: 79/ for test: kms_ccs
results: parsing output: 80/ for test: kms_big_fb
results: parsing output: 81/ for test: kms_frontbuffer_tracking
results: parsing output: 82/ for test: kms_chamelium_audio
results: parsing output: 83/ for test: gem_bad_reloc
results: parsing output: 84/ for test: kms_psr2_sf
results: parsing output: 85/ for test: i915_hangman
results: parsing output: 86/ for test: sysfs_heartbeat_interval
results: parsing output: 87/ for test: kms_universal_plane
results: parsing output: 88/ for test: kms_dp_link_training
results: parsing output: 89/ for test: gem_exec_balancer
results: parsing output: 90/ for test: gem_exec_fence
results: parsing output: 91/ for test: kms_frontbuffer_tracking
results: parsing output: 92/ for test: kms_psr
results: parsing output: 93/ for test: kms_frontbuffer_tracking
results: parsing output: 94/ for test: kms_busy
results: parsing output: 95/ for test: gem_exec_async
results: parsing output: 96/ for test: prime_vgem
results: parsing output: 97/ for test: kms_properties
results: parsing output: 98/ for test: gem_mmap_wc
results: parsing output: 99/ for test: kms_frontbuffer_tracking
results: parsing output: 100/ for test: kms_psr
results: parsing output: 101/ for test: syncobj_timeline
results: parsing output: 102/ for test: perf_pmu
results: parsing output: 103/ for test: kms_plane_scaling
results: parsing output: 104/ for test: gem_exec_whisper
results: parsing output: 105/ for test: gem_pxp
results: parsing output: 106/ for test: gem_exec_reloc
results: parsing output: 107/ for test: kms_content_protection
results: parsing output: 108/ for test: kms_invalid_mode
results: parsing output: 109/ for test: gem_userptr_blits
results: parsing output: 110/ for test: kms_frontbuffer_tracking
results: parsing output: 111/ for test: gem_exec_whisper
results: parsing output: 112/ for test: kms_flip
results: parsing output: 113/ for test: gem_ctx_engines
results: parsing output: 114/ for test: kms_color_pipeline
results: parsing output: 115/ for test: kms_plane
results: parsing output: 116/ for test: kms_plane_cursor
results: parsing output: 117/ for test: kms_big_fb
results: parsing output: 118/ for test: gen9_exec_parse
results: parsing output: 119/ for test: gem_render_copy
results: parsing output: 120/ for test: kms_cursor_crc
results: parsing output: 121/ for test: dumb_buffer
results: parsing output: 122/ for test: syncobj_timeline
results: parsing output: 123/ for test: kms_big_fb
results: parsing output: 124/ for test: kms_frontbuffer_tracking
results: parsing output: 125/ for test: i915_pm_rc6_residency
results: parsing output: 126/ for test: kms_pm_rpm
results: parsing output: 127/ for test: gem_mmap_offset
results: parsing output: 128/ for test: kms_frontbuffer_tracking
results: parsing output: 129/ for test: kms_properties
results: parsing output: 130/ for test: syncobj_wait
results: parsing output: 131/ for test: gem_softpin
results: parsing output: 132/ for test: kms_frontbuffer_tracking
Done.