Attachment 125457 Details for Bug 79052 – IVB-kms_flip__vblank_vs_suspend-output

IVB-kms_flip__vblank_vs_suspend-output

IVB-kms_flip__vblank_vs_suspend-output.txt (text/plain), 9.89 KB, created by cprigent on 2016-08-01 08:35:09 UTC

(hide)

Description:

Filename:

MIME Type:

Creator: cprigent

Created: 2016-08-01 08:35:09 UTC

Size: 9.89 KB

patch

obsolete

>root@IVB102:/opt/X11R7/src/intel-gpu-tools/tests# ./kms_flip --r vblank-vs-suspend
>IGT-Version: 1.15-g53b4dfd (x86_64) (Linux: 4.7.0-nightly+ x86_64)
>Using monotonic timestamps
>Beginning vblank-vs-suspend on pipe A, connector VGA-1
>  1024x768 60 1024 1048 1184 1344 768 771 777 806 0xa 0x40 65000
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:49:24 2016
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:49:45 2016
>
>vblank-vs-suspend on pipe A, connector VGA-1: PASSED
>
>Beginning vblank-vs-suspend on pipe A, connector DP-2
>  1920x1080 60 1920 2008 2052 2200 1080 1084 1089 1125 0x5 0x48 148500
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:50:06 2016
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:50:27 2016
>(kms_flip:6527) CRITICAL: Test assertion failure function check_state, file kms_flip.c:682:
>(kms_flip:6527) CRITICAL: Failed assertion: es->current_seq - es->last_seq <= 150
>(kms_flip:6527) CRITICAL: unexpected vblank seq 23395, should be < 23324
>Stack trace:
>  #0 [__igt_fail_assert+0xf1]
>  #1 [check_state+0x3c1]
>  #2 [run_test_on_crtc_set.constprop.13+0xbf5]
>  #3 [run_test+0x25a]
>  #4 [main+0x508]
>  #5 [__libc_start_main+0xf0]
>  #6 [_start+0x29]
>  #7 [<unknown>+0x29]
>Subtest vblank-vs-suspend failed.
>**** DEBUG ****
>(kms_flip:6527) DEBUG: Test requirement passed: (flags & TEST_HANG) == 0 || !is_wedged(drm_fd)
>(kms_flip:6527) DEBUG: Test requirement passed: modes
>(kms_flip:6527) INFO: Beginning vblank-vs-suspend on pipe A, connector VGA-1
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1024, height=768, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=2, pitch=4096)
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1024, height=768, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=3, pitch=4096)
>(kms_flip:6527) igt-kms-INFO:   1024x768 60 1024 1048 1184 1344 768 771 777 806 0xa 0x40 65000
>(kms_flip:6527) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:6527) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:6527) DEBUG: name = vblank
>last_ts = 0.000000
>last_received_ts = 0.000000
>last_seq = 0
>current_ts = 384.275477
>current_received_ts = 386.101912
>current_seq = 22896
>count = 0
>seq_step = 10
>(kms_flip:6527) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:6527) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:6527) DEBUG: name = vblank
>last_ts = 384.275477
>last_received_ts = 386.101912
>last_seq = 22896
>current_ts = 386.261634
>current_received_ts = 390.056266
>current_seq = 22976
>count = 1
>seq_step = 10
>(kms_flip:6527) DEBUG: testing ts continuity: Current frame 22976, old frame 22896
>(kms_flip:6527) INFO:
>vblank-vs-suspend on pipe A, connector VGA-1: PASSED
>
>(kms_flip:6527) INFO: Beginning vblank-vs-suspend on pipe A, connector DP-2
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1920, height=1080, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=2, pitch=7680)
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1920, height=1080, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:6527) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=3, pitch=7680)
>(kms_flip:6527) igt-kms-INFO:   1920x1080 60 1920 2008 2052 2200 1080 1084 1089 1125 0x5 0x48 148500
>(kms_flip:6527) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:6527) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:6527) DEBUG: name = vblank
>last_ts = 0.000000
>last_received_ts = 0.000000
>last_seq = 0
>current_ts = 390.352018
>current_received_ts = 394.596654
>current_seq = 23174
>count = 0
>seq_step = 10
>(kms_flip:6527) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:6527) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:6527) DEBUG: name = vblank
>last_ts = 390.352018
>last_received_ts = 394.596654
>last_seq = 23174
>current_ts = 394.748515
>current_received_ts = 399.085772
>current_seq = 23395
>count = 1
>seq_step = 10
>(kms_flip:6527) CRITICAL: Test assertion failure function check_state, file kms_flip.c:682:
>(kms_flip:6527) CRITICAL: Failed assertion: es->current_seq - es->last_seq <= 150
>(kms_flip:6527) CRITICAL: unexpected vblank seq 23395, should be < 23324
>****  END  ****
>Subtest vblank-vs-suspend: FAIL (18.429s)
>root@IVB102:/opt/X11R7/src/intel-gpu-tools/tests#
>root@IVB102:/opt/X11R7/src/intel-gpu-tools/tests#
>root@IVB102:/opt/X11R7/src/intel-gpu-tools/tests#
>root@IVB102:/opt/X11R7/src/intel-gpu-tools/tests#
>root@IVB102:/opt/X11R7/src/intel-gpu-tools/tests# ./kms_flip --r vblank-vs-suspend-interruptible
>IGT-Version: 1.15-g53b4dfd (x86_64) (Linux: 4.7.0-nightly+ x86_64)
>Using monotonic timestamps
>Beginning vblank-vs-suspend-interruptible on pipe A, connector VGA-1
>  1024x768 60 1024 1048 1184 1344 768 771 777 806 0xa 0x40 65000
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:52:05 2016
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:52:26 2016
>
>vblank-vs-suspend-interruptible on pipe A, connector VGA-1: PASSED
>
>Beginning vblank-vs-suspend-interruptible on pipe A, connector DP-2
>  1920x1080 60 1920 2008 2052 2200 1080 1084 1089 1125 0x5 0x48 148500
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:52:47 2016
>.rtcwake: assuming RTC uses UTC ...
>rtcwake: wakeup from "mem" using /dev/rtc0 at Tue Aug  2 22:53:08 2016
>(kms_flip:7495) CRITICAL: Test assertion failure function check_state, file kms_flip.c:682:
>(kms_flip:7495) CRITICAL: Failed assertion: es->current_seq - es->last_seq <= 150
>(kms_flip:7495) CRITICAL: Last errno: 4, Interrupted system call
>(kms_flip:7495) CRITICAL: unexpected vblank seq 28898, should be < 28825
>Stack trace:
>  #0 [__igt_fail_assert+0xf1]
>  #1 [check_state+0x3c1]
>  #2 [run_test_on_crtc_set.constprop.13+0xbf5]
>  #3 [run_test+0x25a]
>  #4 [main+0x540]
>  #5 [__libc_start_main+0xf0]
>  #6 [_start+0x29]
>  #7 [<unknown>+0x29]
>Subtest vblank-vs-suspend-interruptible failed.
>**** DEBUG ****
>(kms_flip:7495) DEBUG: Test requirement passed: (flags & TEST_HANG) == 0 || !is_wedged(drm_fd)
>(kms_flip:7495) DEBUG: Test requirement passed: modes
>(kms_flip:7495) INFO: Beginning vblank-vs-suspend-interruptible on pipe A, connector VGA-1
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1024, height=768, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=2, pitch=4096)
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1024, height=768, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=3, pitch=4096)
>(kms_flip:7495) igt-kms-INFO:   1024x768 60 1024 1048 1184 1344 768 771 777 806 0xa 0x40 65000
>(kms_flip:7495) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:7495) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:7495) DEBUG: name = vblank
>last_ts = 0.000000
>last_received_ts = 0.000000
>last_seq = 0
>current_ts = 478.815083
>current_received_ts = 480.081989
>current_seq = 28395
>count = 0
>seq_step = 10
>(kms_flip:7495) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:7495) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:7495) DEBUG: name = vblank
>last_ts = 478.815083
>last_received_ts = 480.081989
>last_seq = 28395
>current_ts = 480.236393
>current_received_ts = 484.622365
>current_seq = 28439
>count = 1
>seq_step = 10
>(kms_flip:7495) DEBUG: testing ts continuity: Current frame 28439, old frame 28395
>(kms_flip:7495) INFO:
>vblank-vs-suspend-interruptible on pipe A, connector VGA-1: PASSED
>
>(kms_flip:7495) INFO: Beginning vblank-vs-suspend-interruptible on pipe A, connector DP-2
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1920, height=1080, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=2, pitch=7680)
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(width=1920, height=1080, format=0x34325258, tiling=0x0, size=0)
>(kms_flip:7495) igt-fb-DEBUG: igt_create_fb_with_bo_size(handle=3, pitch=7680)
>(kms_flip:7495) igt-kms-INFO:   1920x1080 60 1920 2008 2052 2200 1080 1084 1089 1125 0x5 0x48 148500
>(kms_flip:7495) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:7495) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:7495) DEBUG: name = vblank
>last_ts = 0.000000
>last_received_ts = 0.000000
>last_seq = 0
>current_ts = 484.907398
>current_received_ts = 489.155276
>current_seq = 28675
>count = 0
>seq_step = 10
>(kms_flip:7495) igt-core-DEBUG: Test requirement passed: !igt_run_in_simulation()
>(kms_flip:7495) igt-aux-DEBUG: Test requirement passed: system("rtcwake -n -s 15 -m mem" SQUELCH) == 0
>(kms_flip:7495) DEBUG: name = vblank
>last_ts = 484.907398
>last_received_ts = 489.155276
>last_seq = 28675
>current_ts = 489.310559
>current_received_ts = 493.761352
>current_seq = 28898
>count = 1
>seq_step = 10
>(kms_flip:7495) CRITICAL: Test assertion failure function check_state, file kms_flip.c:682:
>(kms_flip:7495) CRITICAL: Failed assertion: es->current_seq - es->last_seq <= 150
>(kms_flip:7495) CRITICAL: Last errno: 4, Interrupted system call
>(kms_flip:7495) CRITICAL: unexpected vblank seq 28898, should be < 28825
>****  END  ****
>Subtest vblank-vs-suspend-interruptible: FAIL (15.145s)

Actions: View

Attachments on bug 79052: 99555 | 99560 | 99849 | 122145 | 122559 | 122560 | 125456 | 125457 | 128279

Use of freedesktop.org services, including Bugzilla, is subject to our Code of Conduct. How we collect and use information is described in our Privacy Policy.