Question / Help Framerate issues not expected

[icharlie17]

Hi, I'd like to stream 720p @30fps Dota 2 in Twitch and/or YouTube with OBS.

I have a machine that I think it's powerful enough to play and stream Dota 2 but when I stream my viewers say that there is lag and framedrops :(. Previously I didn't have that many issues I think. I bought a second monitor a month ago to help me stream and I have this problem now. Can a second monitor be the cause of the framerate issues? I thought that a second screen with just the twitch chat in google chrome wouldn't take that much power :S

Or maybe is just that I have bad configuration in my OBS settings or something. I could really use some advice/help here.

This is my machine:
-Intel Core i7 930 @ 3.6 Ghz
-Prolimatech Megahalens rev B + Scythe Gentle Typhoon 1450 rpm
-Gigabyte GA-EX58-UD3R v2
-3x2 GB GSkill DDR3-1600 Pi Series
-SLI 2x MSI Cyclone GTX460 1 GB OC
-Samsung 840 250GB (SSD)
-Seagate 1 TB SATA2 HDD
-Seagate 2 TB SATA2 HDD
-Grabadora DVD LG
-Corsair AX750 W
-Cooler Master HAF X 942
-Yeti Blue microphone
-2x 24 inch 1080p monitors.

And this is my internet connection test:

I add also all my OBS settings for better help/advice:

Spoiler

 

[Sapiens]

Post a log - viewtopic.php?f=5&t=97

 

[icharlie17]

Hello. First I want to say thank you for answering. I'm kind of newbie in this so I have to ask. Do I have to stream for maybe 10 mins and then get the log?

 

[Sapiens]

That would work fine if you don't already have a recent log from a streaming session that had issues.

 

[icharlie17]

Ok got it. I ran a stream test for around 5-10 mins and got this log file. I watched the stream on the second monitor and it was laggy as hell :/

Here's the log file (I hope I got the file right):

21:54:19: Open Broadcaster Software v0.60b - 64bit (　^ω^)
21:54:19: -------------------------------
21:54:19: CPU Name: Intel(R) Core(TM) i7 CPU         930  @ 2.80GHz
21:54:19: CPU Speed: 3612MHz
21:54:19: Physical Memory:  6142MB Total, 2780MB Free
21:54:19: stepping id: 5, model 26, family 6, type 0, extmodel 0, extfamily 0, HTT 1, logical cores 8, total cores 4
21:54:19: monitor 1: pos={-1920, 0}, size={1920, 1080}
21:54:19: monitor 2: pos={0, 0}, size={1920, 1080}
21:54:19: Windows Version: 6.1 Build 7601 S
21:54:19: Aero is Enabled
21:54:19: -------------------------------
21:54:19: OBS Modules:
21:54:19: Base Address     Module
21:54:19: 000000003F2B0000 OBS.exe
21:54:19: 00000000FB1D0000 OBSApi.dll
21:54:19: 00000000FB5B0000 DShowPlugin.dll
21:54:19: 00000000FB580000 GraphicsCapture.dll
21:54:19: 00000000FB1B0000 NoiseGate.dll
21:54:19: 00000000FB190000 PSVPlugin.dll
21:54:19: ------------------------------------------
21:54:19: Adapter 1
21:54:19:   Video Adapter: NVIDIA GeForce GTX 460
21:54:19:   Video Adapter Dedicated Video Memory: 1024917504
21:54:19:   Video Adapter Shared System Memory: 2951962624
21:54:19:   Video Adapter Output 1: pos={0, 0}, size={1920, 1080}, attached=true
21:54:19:   Video Adapter Output 2: pos={-1920, 0}, size={1920, 1080}, attached=true
21:54:19: =====Stream Start: 2014-02-03, 21:54:19===============================================
21:54:19:   Multithreaded optimizations: On
21:54:19:   Base resolution: 1920x1080
21:54:19:   Output resolution: 1280x720
21:54:19: ------------------------------------------
21:54:19: Loading up D3D10 on NVIDIA GeForce GTX 460 (Adapter 1)...
21:54:19: ------------------------------------------
21:54:19: Audio Format: 48000hz
21:54:19: Playback device Default
21:54:19: ------------------------------------------
21:54:19: Using desktop audio input: Audífono del auricular (ASTRO MixAmp Pro           )
21:54:19: ------------------------------------------
21:54:19: Audio Encoding: AAC
21:54:19:     bitrate: 128
21:54:19: Using graphics capture
21:54:19: Scene buffering time set to 700
21:54:19: ------------------------------------------
21:54:19: Video Encoding: x264
21:54:19:     fps: 30
21:54:19:     width: 1280, height: 720
21:54:19:     preset: veryfast
21:54:19:     profile: main
21:54:19:     keyint: 60
21:54:19:     CBR: yes
21:54:19:     CFR: yes
21:54:19:     max bitrate: 1300
21:54:19:     buffer size: 1300
21:54:19: ------------------------------------------
21:54:19: SharedTexCapture hooked
21:55:13: Total frames encoded: 1597, total frames duplicated: 0 (0.00%)
21:55:13: Total frames rendered: 1601, number of late frames: 0 (0.00%) (it's okay for some frames to be late)
21:55:13: 
21:55:13: Profiler time results:
21:55:13: 
21:55:13: ==============================================================
21:55:13: video thread frame - [100%] [avg time: 0.444 ms] [children: 12.4%] [unaccounted: 87.6%]
21:55:13: | scene->Preprocess - [0.225%] [avg time: 0.001 ms]
21:55:13: | GPU download and conversion - [12.2%] [avg time: 0.054 ms] [children: 9.91%] [unaccounted: 2.25%]
21:55:13: | | flush - [7.88%] [avg time: 0.035 ms]
21:55:13: | | CopyResource - [1.8%] [avg time: 0.008 ms]
21:55:13: | | conversion to 4:2:0 - [0.225%] [avg time: 0.001 ms]
21:55:13: Convert444Threads - [100%] [avg time: 0.4 ms] [children: 99.3%] [unaccounted: 0.75%]
21:55:13: | Convert444toNV12 - [99.3%] [avg time: 0.397 ms]
21:55:13: encoder thread frame - [100%] [avg time: 0.768 ms]
21:55:13: ==============================================================
21:55:13: 
21:55:13: 
21:55:13: Profiler CPU results:
21:55:13: 
21:55:13: ==============================================================
21:55:13: video thread frame - [cpu time: avg 0.019 ms, total 31.2 ms] [avg calls per frame: 1]
21:55:13: | scene->Preprocess - [cpu time: avg 0 ms, total 0 ms] [avg calls per frame: 1]
21:55:13: | GPU download and conversion - [cpu time: avg 0 ms, total 0 ms] [avg calls per frame: 1]
21:55:13: | | flush - [cpu time: avg 0 ms, total 0 ms] [avg calls per frame: 1]
21:55:13: | | CopyResource - [cpu time: avg 0 ms, total 0 ms] [avg calls per frame: 1]
21:55:13: | | conversion to 4:2:0 - [cpu time: avg 0 ms, total 0 ms] [avg calls per frame: 1]
21:55:13: Convert444Threads - [cpu time: avg 0.054 ms, total 171.6 ms] [avg calls per frame: 2]
21:55:13: | Convert444toNV12 - [cpu time: avg 0.054 ms, total 171.6 ms] [avg calls per frame: 2]
21:55:13: encoder thread frame - [cpu time: avg 0.069 ms, total 109.2 ms] [avg calls per frame: 1]
21:55:13: ==============================================================
21:55:13: 
21:55:13: =====Stream End: 2014-02-03, 21:55:13=================================================
21:55:16: =====Stream Start: 2014-02-03, 21:55:16===============================================
21:55:16:   Multithreaded optimizations: On
21:55:16:   Base resolution: 1920x1080
21:55:16:   Output resolution: 1280x720
21:55:16: ------------------------------------------
21:55:16: Loading up D3D10 on NVIDIA GeForce GTX 460 (Adapter 1)...
21:55:16: ------------------------------------------
21:55:16: Audio Format: 48000hz
21:55:16: Playback device Default
21:55:16: ------------------------------------------
21:55:16: Using desktop audio input: Audífono del auricular (ASTRO MixAmp Pro           )
21:55:16: ------------------------------------------
21:55:16: Audio Encoding: AAC
21:55:16:     bitrate: 128
21:55:16: Using graphics capture
21:55:16: Scene buffering time set to 700
21:55:16: ------------------------------------------
21:55:16: Video Encoding: x264
21:55:16:     fps: 30
21:55:16:     width: 1280, height: 720
21:55:16:     preset: veryfast
21:55:16:     profile: main
21:55:16:     keyint: 60
21:55:16:     CBR: yes
21:55:16:     CFR: yes
21:55:16:     max bitrate: 1300
21:55:16:     buffer size: 1300
21:55:16: ------------------------------------------
21:55:18: Using RTMP service: Twitch / Justin.tv
21:55:18:   Server selection: rtmp://live-lhr.justin.tv/app
21:55:18:   Interface: Realtek PCIe GBE Family Controller (ethernet, 1000 mbps)
21:55:19: Completed handshake with rtmp://live-lhr.justin.tv/app in 415 ms.
21:55:19: SharedTexCapture hooked
21:55:20: SO_SNDBUF was at 8192
21:55:20: SO_SNDBUF is now 65536
21:55:21: RTMPPublisher::SocketLoop: Increasing send buffer to ISB 131072 (buffer: 0 / 182272)
21:55:23: RTMPPublisher::SocketLoop: Increasing send buffer to ISB 262144 (buffer: 0 / 182272)
21:59:41: Total frames encoded: 7931, total frames duplicated: 0 (0.00%)
21:59:41: Total frames rendered: 7936, number of late frames: 1 (0.01%) (it's okay for some frames to be late)
21:59:41: RTMPPublisher::SocketLoop: Graceful loop exit
21:59:41: Average send payload: 4757 bytes, average send interval: 26 ms
21:59:41: Number of times waited to send: 0, Waited for a total of 0 bytes
21:59:41: Number of b-frames dropped: 0 (0%), Number of p-frames dropped: 0 (0%), Total 0 (0%)
21:59:41: Number of bytes sent: 46824175
21:59:41: 
21:59:41: Profiler time results:
21:59:41: 
21:59:41: ==============================================================
21:59:41: video thread frame - [100%] [avg time: 0.604 ms] [children: 18.4%] [unaccounted: 81.6%]
21:59:41: | scene->Preprocess - [0.166%] [avg time: 0.001 ms]
21:59:41: | GPU download and conversion - [18.2%] [avg time: 0.11 ms] [children: 14.9%] [unaccounted: 3.31%]
21:59:41: | | flush - [12.1%] [avg time: 0.073 ms]
21:59:41: | | CopyResource - [2.48%] [avg time: 0.015 ms]
21:59:41: | | conversion to 4:2:0 - [0.331%] [avg time: 0.002 ms]
21:59:41: Convert444Threads - [100%] [avg time: 0.487 ms] [children: 99.4%] [unaccounted: 0.616%]
21:59:41: | Convert444toNV12 - [99.4%] [avg time: 0.484 ms]
21:59:41: encoder thread frame - [100%] [avg time: 0.858 ms]
21:59:41: ==============================================================
21:59:41: 
21:59:41: 
21:59:41: Profiler CPU results:
21:59:41: 
21:59:41: ==============================================================
21:59:41: video thread frame - [cpu time: avg 0.08 ms, total 639.604 ms] [avg calls per frame: 1]
21:59:41: | scene->Preprocess - [cpu time: avg 0 ms, total 0 ms] [avg calls per frame: 1]
21:59:41: | GPU download and conversion - [cpu time: avg 0.011 ms, total 93.601 ms] [avg calls per frame: 1]
21:59:41: | | flush - [cpu time: avg 0.007 ms, total 62.4 ms] [avg calls per frame: 1]
21:59:41: | | CopyResource - [cpu time: avg 0.003 ms, total 31.201 ms] [avg calls per frame: 1]
21:59:41: | | conversion to 4:2:0 - [cpu time: avg 0 ms, total 0 ms] [avg calls per frame: 1]
21:59:41: Convert444Threads - [cpu time: avg 0.351 ms, total 5553.63 ms] [avg calls per frame: 2]
21:59:41: | Convert444toNV12 - [cpu time: avg 0.35 ms, total 5538.03 ms] [avg calls per frame: 2]
21:59:41: encoder thread frame - [cpu time: avg 0.122 ms, total 967.206 ms] [avg calls per frame: 1]
21:59:41: ==============================================================
21:59:41: 
21:59:41: =====Stream End: 2014-02-03, 21:59:41=================================================


Last game capture log:
2014-02-03, 21:54:19: we're booting up: 
21:54:19: CaptureThread: attached to process dota.exe
21:54:19: D3D9 Present
21:54:19: D3D9EndScene called
21:54:19: D3DPRESENT_PARAMETERS {
21:54:19: 	BackBufferWidth: 1920
21:54:19: 	BackBufferHeight: 1080
21:54:19: 	BackBufferFormat: D3DFMT_A8R8G8B8
21:54:19: 	BackBufferCount: 1
21:54:19: 	MultiSampleType: D3DMULTISAMPLE_NONE
21:54:19: 	MultiSampleQuality: 0
21:54:19: 	SwapEffect: D3DSWAPEFFECT_DISCARD
21:54:19: 	hDeviceWindow: 722880
21:54:19: 	Windowed: true
21:54:19: 	EnableAutoDepthStencil: true
21:54:19: 	AutoDepthStencilFormat: D3DFMT_D24S8
21:54:19: 	Flags: None
21:54:19: 	FullScreen_RefreshRateInHz: 0
21:54:19: 	PresentationInterval: 2147483648
21:54:19: };
21:54:19: successfully set up d3d9 hooks
21:54:19: D3D9Present called
21:54:19: DoD3D9GPUHook: success - d3d9ex
21:54:19: D3DSURFACE_DESC {
21:54:19: 	Format: D3DFMT_A8R8G8B8
21:54:19: 	Type: D3DRTYPE_SURFACE
21:54:19: 	Usage: D3DUSAGE_RENDERTARGET 
21:54:19: 	Pool: D3DPOOL_DEFAULT
21:54:19: 	MultiSampleType: D3DMULTISAMPLE_NONE
21:54:19: 	MultiSampleQuality: 0
21:54:19: 	Width: 1920
21:54:19: 	Height: 1080
21:54:19: };
21:54:19: successfully capturing d3d9 frames via GPU
21:54:19: NV Capture available
21:54:19: FBO available
21:54:19: GL Present
21:54:19: (half life scientist) everything..  seems to be in order
21:55:14: ---------------------- Cleared D3D9 Capture ----------------------
21:55:14: D3D9EndScene called
21:55:19: D3D9Present called
21:55:19: received restart event, capturing
21:55:19: DoD3D9GPUHook: success - d3d9ex
21:55:19: D3DSURFACE_DESC {
21:55:19: 	Format: D3DFMT_A8R8G8B8
21:55:19: 	Type: D3DRTYPE_SURFACE
21:55:19: 	Usage: D3DUSAGE_RENDERTARGET 
21:55:19: 	Pool: D3DPOOL_DEFAULT
21:55:19: 	MultiSampleType: D3DMULTISAMPLE_NONE
21:55:19: 	MultiSampleQuality: 0
21:55:19: 	Width: 1920
21:55:19: 	Height: 1080
21:55:19: };
21:55:19: successfully capturing d3d9 frames via GPU
21:59:41: ---------------------- Cleared D3D9 Capture ----------------------
21:59:41: received restart event, capturing
21:59:41: DoD3D9GPUHook: success - d3d9ex
21:59:41: D3D9EndScene called
21:59:41: D3D9Present called

thank you again for helping me out!!

PD: Not sure if it helps in any way but here's the VoD of the test I just did. Check for example min 1:57 with massive drops: http://www.twitch.tv/canalg40/b/500521257

 

[icharlie17]

Please I posted everything asked for. Can anyone help me?

 

[Krazy]

Well, everything in your log checks out completely fine, OBS is running pretty much perfectly, and you are getting all the data to the Twitch servers. It would appear, then, that your viewers are simply having trouble downloading the stream fast enough from the Twitch server in order to view it. There's really not much you can do about that other than lower bitrate until it stops, but you're already quite low for 720p30fps.

 

[icharlie17]

But that doesn't make ant sense right? I mean I have a good internet connection and even checking my local record (I save my streams in the hard drive) it is laggy as the livestream :(. I lowered the bitrate a lot (1300kbps with 100mb connection is very low) and i still get this massive drops :(

 

[Sapiens]

It has nothing to do with your internet connection, or OBS settings, or anything else on your end. The stream itself is fine, you have no dropped frames. It's an issue with viewers being able to get data from Twitch fast enough.

 

[icharlie17]

I asked if has something to do with my connection cause I don't understand how can't I be able to get data fast enough from Twitch if I have that 100 mb speed -_-. And my local recording is also lagged which (I'm guessing here) doesn't need to get data fast enough from Twitch.

I'm gonna ask a friend who also streams to see if I can get this fixed with his settings or something.

thanks a lot for your help!

 

[Sapiens]

The log file you posted shows no indication of "lagging" - no dropped frames, no late frames, a single duplicate frame out of almost 8000 - but is also for a brief 4-5 minute test. If you had a problem at some other point then that would be reflected in a different log file. We can only troubleshoot with the information you provide to us, so if you'd like us to help further you should get a log file from a stream/recording that exhibited some type of issue.