This Bugzilla instance is a read-only archive of historic NetBeans bug reports. To report a bug in NetBeans please follow the project's instructions for reporting issues.

Bug 225077 - One Line change and Save in Java File takes 3 times as long in 7.3 vs 7.1.2
Summary: One Line change and Save in Java File takes 3 times as long in 7.3 vs 7.1.2
Status: RESOLVED INCOMPLETE
Alias: None
Product: ide
Classification: Unclassified
Component: Performance (show other bugs)
Version: 7.3
Hardware: PC Windows XP
: P2 normal (vote)
Assignee: Tomas Hurka
URL:
Keywords: PERFORMANCE
Depends on:
Blocks:
 
Reported: 2013-01-18 20:31 UTC by bht
Modified: 2013-01-31 17:10 UTC (History)
2 users (show)

See Also:
Issue Type: DEFECT
Exception Reporter:


Attachments
7.3 snapshot (71.78 KB, application/octet-stream)
2013-01-18 20:31 UTC, bht
Details
7.1.2 snapshot (69.77 KB, application/octet-stream)
2013-01-18 20:32 UTC, bht
Details
log files both 7.1.2 and 7.3 (172.11 KB, application/zip)
2013-01-24 01:20 UTC, bht
Details

Note You need to log in before you can comment on or make changes to this bug.
Description bht 2013-01-18 20:31:27 UTC
Created attachment 130377 [details]
7.3 snapshot

Build 201301120001

The delay at which the "Run Focused Test Method" option becomes available after changes appeared too long to me.

So I made a comparison between 7.1.2 and 7.3.

In both cases the only non-default setting in netbeans.conf is -J-Xmx1000m

NetBeans 7.1.2 is somewhat different because it complains:
The path '<some project path>' appears to be part of a Subversion 1.7 or greater
working copy.  Please upgrade your Subversion client to use this
working copy.


At the top of a larger Java test file (3500 lines) under SVN control, I hit [Enter] (insert one line) and [Ctrl+S] (Save)

Times of 100% CPU in Windows Task Manager:
NetBeans 7.1.2: 12 seconds (19 seconds with "Profile the IDE")
NetBeans 7.3: 36 seconds (42 seconds with "Profile the IDE")

I attach the snapshots that I made with [Alt+Shift+Y] for your evaluation.

I am just hoping that this could be helpful.
Comment 1 bht 2013-01-18 20:32:32 UTC
Created attachment 130378 [details]
7.1.2 snapshot
Comment 2 Marian Mirilovic 2013-01-22 17:48:20 UTC
P1 ... treating as 7.3 HR FIX Candidate
Comment 3 Petr Cyhelsky 2013-01-23 12:58:50 UTC
There are big differences  between how long some native calls take in both snapshots. Did you run both versions of IDE on same jdk? Can you please attach messages.log from both runs?
Comment 4 Tomas Hurka 2013-01-23 13:15:48 UTC
This happens just on one computer, where i/O is very very slow. This is not a general problem, so changing back to P2.
Comment 5 bht 2013-01-24 01:20:19 UTC
Created attachment 130562 [details]
log files both 7.1.2 and 7.3

The JDK is the same for both installations.

To make things equal I started version 7.3 in a new userdir and let it import settings from 7.1.2. Then I started it again to have the same conditions as 7.1.2. However I added more memory (1,000MB) to 7.3 as this was suggested to me.

7.1.2 setings:
netbeans_default_options="-J-client -J-Xss2m -J-Xms32m -J-XX:PermSize=32m -J-Dapple.laf.useScreenMenuBar=true -J-Dapple.awt.graphics.UseQuartz=true -J-Dsun.java2d.noddraw=true -J-Dsun.zip.disableMemoryMapping=true -J-Xmx1000m"
7.3 settings:
netbeans_default_options="-J-client -J-Xss2m -J-Xms32m -J-XX:PermSize=32m -J-Dnetbeans.logger.console=true -J-ea -J-Dapple.laf.useScreenMenuBar=true -J-Dapple.awt.graphics.UseQuartz=true -J-Dsun.java2d.noddraw=true -J-Dsun.java2d.dpiaware=true -J-Dsun.zip.disableMemoryMapping=true -J-Dplugin.manager.check.updates=false -J-Dsun.awt.disableMixing=true -J-Dnetbeans.extbrowser.manual_chrome_plugin_install=yes -J-Xmx1000m"


During the test, 7.1.2 had no additional log file entry. In 7.3 there was only 1 line (976):
WARNING [org.openide.filesystems.FileUtil]: FileUtil.normalizeFile(C:\bt\java\netbeans\bugs\_new\FileSaveSlow\run2\userdir\var\cache\index\s124\java\14) took 1,219 ms. Result is C:\bt\java\netbeans\bugs\_new\FileSaveSlow\run2\userdir\var\cache\index\s124\java\14

The file is the test root directory of the file opened:
s124=file\:/C\:/_dt/app/gt1/jprj/G1/G1_W/test/

The discrepancies vary between 3 times as slow and 2 times as slow which conforms with my subjective impression. I don't have strong ideas of what is going on. If you asked me I would descibe it as follows:

In addition to the subject of this issue, the IDE eats memory in a specific way, like a ratchet. Consumption stays low with a very slow working style - small files, only one line changes with pauses. If I edit, open and close files about one every 10 seconds, which at the same time lets the CPU go to 100% almost constantly, then memory consumption goes up slightly durnig the day hitting the limit at 800MB (max) inside NetBeans and 1GB seen in Task Manager at the end of the day. However I was never concerned about it because garbage collection trims the lower value back to 300MB or so. Performance degrades at the same time. As I reported seeparately in bug 225157, shutdown takes up to 20 minutes after such a session. Here, 7.3 shutdown was 48 seconds compared with 7.1.2 18 seconds.

I/O slowness is a feature of this PC but I wanted to show with this that this does not explain away the relativity in this issue.
Comment 6 Petr Cyhelsky 2013-01-31 17:10:17 UTC
Please provide following information from the some one run -

1. Self sampling snapshot - npss
2. Output from http://technet.microsoft.com/en-us/sysinternals/bb896645.aspx
3. Messages.log