[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[
https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16632983#comment-16632983
]
Hudson commented on HBASE-21188:
Results for branch master
[build #517 on
builds.a.o|https://builds.apache.org/job/HBase%20Nightly/job/master/517/]: (x)
*{color:red}-1 overall{color}*
details (if available):
(/) {color:green}+1 general checks{color}
-- For more information [see general
report|https://builds.apache.org/job/HBase%20Nightly/job/master/517//General_Nightly_Build_Report/]
(x) {color:red}-1 jdk8 hadoop2 checks{color}
-- For more information [see jdk8 (hadoop2)
report|https://builds.apache.org/job/HBase%20Nightly/job/master/517//JDK8_Nightly_Build_Report_(Hadoop2)/]
(x) {color:red}-1 jdk8 hadoop3 checks{color}
-- For more information [see jdk8 (hadoop3)
report|https://builds.apache.org/job/HBase%20Nightly/job/master/517//JDK8_Nightly_Build_Report_(Hadoop3)/]
(/) {color:green}+1 source release artifact{color}
-- See build output for details.
(/) {color:green}+1 client integration test{color}
> Print heap and gc informations in our junit ResourceChecker
> ---
>
> Key: HBASE-21188
> URL: https://issues.apache.org/jira/browse/HBASE-21188
> Project: HBase
> Issue Type: Sub-task
> Components: test
>Reporter: Duo Zhang
>Assignee: Duo Zhang
>Priority: Major
> Fix For: 3.0.0, 2.2.0
>
> Attachments: HBASE-21188.patch
>
>
--
This message was sent by Atlassian JIRA
(v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[ https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16617082#comment-16617082 ] stack commented on HBASE-21188: --- +1 on patch. Could help. > Print heap and gc informations in our junit ResourceChecker > --- > > Key: HBASE-21188 > URL: https://issues.apache.org/jira/browse/HBASE-21188 > Project: HBase > Issue Type: Sub-task > Components: test >Reporter: Duo Zhang >Assignee: Duo Zhang >Priority: Major > Fix For: 3.0.0, 2.2.0 > > Attachments: HBASE-21188.patch > > -- This message was sent by Atlassian JIRA (v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[ https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16614280#comment-16614280 ] Duo Zhang commented on HBASE-21188: --- Just want to confirm that whether GC is a problem for our slow test. At least GC count and GC time should not be considered as a 'Resource'. Will revert the patch later, as it seems that GC is not the actual problem. > Print heap and gc informations in our junit ResourceChecker > --- > > Key: HBASE-21188 > URL: https://issues.apache.org/jira/browse/HBASE-21188 > Project: HBase > Issue Type: Sub-task > Components: test >Reporter: Duo Zhang >Assignee: Duo Zhang >Priority: Major > Fix For: 3.0.0, 2.2.0 > > Attachments: HBASE-21188.patch > > -- This message was sent by Atlassian JIRA (v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[ https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16614076#comment-16614076 ] Mike Drob commented on HBASE-21188: --- What do "GCCount LEAK?" and "UsedHeapMemoryMB LEAK?" mean in this context? Is that why you were suggesting not to track GC as a resource? Total heap usage detecting a leak also seems unlikely, since we probably are building up lots of structures during the tests that maybe we aren't cleaning up, but also maybe don't need to. > Print heap and gc informations in our junit ResourceChecker > --- > > Key: HBASE-21188 > URL: https://issues.apache.org/jira/browse/HBASE-21188 > Project: HBase > Issue Type: Sub-task > Components: test >Reporter: Duo Zhang >Assignee: Duo Zhang >Priority: Major > Fix For: 3.0.0, 2.2.0 > > Attachments: HBASE-21188.patch > > -- This message was sent by Atlassian JIRA (v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[
https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16613489#comment-16613489
]
Hudson commented on HBASE-21188:
Results for branch master
[build #489 on
builds.a.o|https://builds.apache.org/job/HBase%20Nightly/job/master/489/]: (x)
*{color:red}-1 overall{color}*
details (if available):
(/) {color:green}+1 general checks{color}
-- For more information [see general
report|https://builds.apache.org/job/HBase%20Nightly/job/master/489//General_Nightly_Build_Report/]
(x) {color:red}-1 jdk8 hadoop2 checks{color}
-- For more information [see jdk8 (hadoop2)
report|https://builds.apache.org/job/HBase%20Nightly/job/master/489//JDK8_Nightly_Build_Report_(Hadoop2)/]
(x) {color:red}-1 jdk8 hadoop3 checks{color}
-- For more information [see jdk8 (hadoop3)
report|https://builds.apache.org/job/HBase%20Nightly/job/master/489//JDK8_Nightly_Build_Report_(Hadoop3)/]
(/) {color:green}+1 source release artifact{color}
-- See build output for details.
(/) {color:green}+1 client integration test{color}
> Print heap and gc informations in our junit ResourceChecker
> ---
>
> Key: HBASE-21188
> URL: https://issues.apache.org/jira/browse/HBASE-21188
> Project: HBase
> Issue Type: Sub-task
> Components: test
>Reporter: Duo Zhang
>Assignee: Duo Zhang
>Priority: Major
> Fix For: 3.0.0, 2.2.0
>
> Attachments: HBASE-21188.patch
>
>
--
This message was sent by Atlassian JIRA
(v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[ https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16613276#comment-16613276 ] Duo Zhang commented on HBASE-21188: --- So at least the problem is not GC... https://builds.apache.org/job/HBase-Flaky-Tests/job/master/617/artifact/hbase-server/target/surefire-reports/org.apache.hadoop.hbase.client.TestRestoreSnapshotFromClientWithRegionReplicas-output.txt/*view*/ The memory usage is low, and the time we spend on GC is also very small... > Print heap and gc informations in our junit ResourceChecker > --- > > Key: HBASE-21188 > URL: https://issues.apache.org/jira/browse/HBASE-21188 > Project: HBase > Issue Type: Sub-task > Components: test >Reporter: Duo Zhang >Assignee: Duo Zhang >Priority: Major > Fix For: 3.0.0, 2.2.0 > > Attachments: HBASE-21188.patch > > -- This message was sent by Atlassian JIRA (v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[ https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16612934#comment-16612934 ] Duo Zhang commented on HBASE-21188: --- Pushed to master. > Print heap and gc informations in our junit ResourceChecker > --- > > Key: HBASE-21188 > URL: https://issues.apache.org/jira/browse/HBASE-21188 > Project: HBase > Issue Type: Sub-task > Components: test >Reporter: Duo Zhang >Assignee: Duo Zhang >Priority: Major > Fix For: 3.0.0, 2.2.0 > > Attachments: HBASE-21188.patch > > -- This message was sent by Atlassian JIRA (v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[ https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16612930#comment-16612930 ] Duo Zhang commented on HBASE-21188: --- Anyway let me commit to master to see if it could help debugging the failed UTs. Can revert or push addendum later. > Print heap and gc informations in our junit ResourceChecker > --- > > Key: HBASE-21188 > URL: https://issues.apache.org/jira/browse/HBASE-21188 > Project: HBase > Issue Type: Sub-task > Components: test >Reporter: Duo Zhang >Assignee: Duo Zhang >Priority: Major > Fix For: 3.0.0, 2.2.0 > > Attachments: HBASE-21188.patch > > -- This message was sent by Atlassian JIRA (v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[
https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16612290#comment-16612290
]
Hadoop QA commented on HBASE-21188:
---
| (/) *{color:green}+1 overall{color}* |
\\
\\
|| Vote || Subsystem || Runtime || Comment ||
| {color:blue}0{color} | {color:blue} reexec {color} | {color:blue} 0m
16s{color} | {color:blue} Docker mode activated. {color} |
|| || || || {color:brown} Prechecks {color} ||
| {color:green}+1{color} | {color:green} hbaseanti {color} | {color:green} 0m
0s{color} | {color:green} Patch does not have any anti-patterns. {color} |
| {color:green}+1{color} | {color:green} @author {color} | {color:green} 0m
0s{color} | {color:green} The patch does not contain any @author tags. {color} |
| {color:green}+1{color} | {color:green} test4tests {color} | {color:green} 0m
0s{color} | {color:green} The patch appears to include 1 new or modified test
files. {color} |
|| || || || {color:brown} master Compile Tests {color} ||
| {color:green}+1{color} | {color:green} mvninstall {color} | {color:green} 6m
25s{color} | {color:green} master passed {color} |
| {color:green}+1{color} | {color:green} compile {color} | {color:green} 0m
36s{color} | {color:green} master passed {color} |
| {color:green}+1{color} | {color:green} checkstyle {color} | {color:green} 0m
29s{color} | {color:green} master passed {color} |
| {color:green}+1{color} | {color:green} shadedjars {color} | {color:green} 5m
7s{color} | {color:green} branch has no errors when building our shaded
downstream artifacts. {color} |
| {color:green}+1{color} | {color:green} findbugs {color} | {color:green} 0m
47s{color} | {color:green} master passed {color} |
| {color:green}+1{color} | {color:green} javadoc {color} | {color:green} 0m
21s{color} | {color:green} master passed {color} |
|| || || || {color:brown} Patch Compile Tests {color} ||
| {color:green}+1{color} | {color:green} mvninstall {color} | {color:green} 5m
48s{color} | {color:green} the patch passed {color} |
| {color:green}+1{color} | {color:green} compile {color} | {color:green} 0m
34s{color} | {color:green} the patch passed {color} |
| {color:green}+1{color} | {color:green} javac {color} | {color:green} 0m
34s{color} | {color:green} the patch passed {color} |
| {color:green}+1{color} | {color:green} checkstyle {color} | {color:green} 0m
27s{color} | {color:green} the patch passed {color} |
| {color:green}+1{color} | {color:green} whitespace {color} | {color:green} 0m
0s{color} | {color:green} The patch has no whitespace issues. {color} |
| {color:green}+1{color} | {color:green} shadedjars {color} | {color:green} 4m
45s{color} | {color:green} patch has no errors when building our shaded
downstream artifacts. {color} |
| {color:green}+1{color} | {color:green} hadoopcheck {color} | {color:green}
12m 14s{color} | {color:green} Patch does not cause any errors with Hadoop
2.7.4 or 3.0.0. {color} |
| {color:green}+1{color} | {color:green} findbugs {color} | {color:green} 1m
0s{color} | {color:green} the patch passed {color} |
| {color:green}+1{color} | {color:green} javadoc {color} | {color:green} 0m
21s{color} | {color:green} the patch passed {color} |
|| || || || {color:brown} Other Tests {color} ||
| {color:green}+1{color} | {color:green} unit {color} | {color:green} 2m
52s{color} | {color:green} hbase-common in the patch passed. {color} |
| {color:green}+1{color} | {color:green} asflicense {color} | {color:green} 0m
10s{color} | {color:green} The patch does not generate ASF License warnings.
{color} |
| {color:black}{color} | {color:black} {color} | {color:black} 42m 44s{color} |
{color:black} {color} |
\\
\\
|| Subsystem || Report/Notes ||
| Docker | Client=17.05.0-ce Server=17.05.0-ce Image:yetus/hbase:b002b0b |
| JIRA Issue | HBASE-21188 |
| JIRA Patch URL |
https://issues.apache.org/jira/secure/attachment/12939412/HBASE-21188.patch |
| Optional Tests | asflicense javac javadoc unit findbugs shadedjars
hadoopcheck hbaseanti checkstyle compile |
| uname | Linux eb4b3a08e03c 3.13.0-143-generic #192-Ubuntu SMP Tue Feb 27
10:45:36 UTC 2018 x86_64 GNU/Linux |
| Build tool | maven |
| Personality |
/home/jenkins/jenkins-slave/workspace/PreCommit-HBASE-Build/component/dev-support/hbase-personality.sh
|
| git revision | master / 3810ba2c6e |
| maven | version: Apache Maven 3.5.4
(1edded0938998edf8bf061f1ceb3cfdeccf443fe; 2018-06-17T18:33:14Z) |
| Default Java | 1.8.0_181 |
| findbugs | v3.1.0-RC3 |
| Test Results |
https://builds.apache.org/job/PreCommit-HBASE-Build/14398/testReport/ |
| Max. process+thread count | 361 (vs. ulimit of 1) |
| modules | C: hbase-common U: hbase-common |
| Console output |
https://builds.apache.org/job/PreCommit-HBASE-Build/14398/console |
| Powered by | Apache Yetus 0.7.0 http://yetus.apache.org |
This message was automatically generated.
> Print heap and gc informations in our
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[ https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16612207#comment-16612207 ] Duo Zhang commented on HBASE-21188: --- Maybe we should not define GC as a resource... > Print heap and gc informations in our junit ResourceChecker > --- > > Key: HBASE-21188 > URL: https://issues.apache.org/jira/browse/HBASE-21188 > Project: HBase > Issue Type: Sub-task > Components: test >Reporter: Duo Zhang >Assignee: Duo Zhang >Priority: Major > Fix For: 3.0.0, 2.2.0 > > Attachments: HBASE-21188.patch > > -- This message was sent by Atlassian JIRA (v7.6.3#76005)
[jira] [Commented] (HBASE-21188) Print heap and gc informations in our junit ResourceChecker
[
https://issues.apache.org/jira/browse/HBASE-21188?page=com.atlassian.jira.plugin.system.issuetabpanels:comment-tabpanel=16612203#comment-16612203
]
Duo Zhang commented on HBASE-21188:
---
The output is like this
{noformat}
2018-09-12 22:09:20,396 INFO [Time-limited test] hbase.ResourceChecker(148):
before: types.TestCopyOnWriteMaps#testTailMap Thread=8, OpenFileDescriptor=85,
MaxFileDescriptor=4096, SystemLoadAverage=104, ProcessCount=330,
AvailableMemoryMB=1015, MaxHeapMemoryMB=2489, UsedHeapMemoryMB=21, GCCount=0,
GCTimeSecond=0
2018-09-12 22:09:24,759 INFO [Time-limited test] hbase.ResourceChecker(172):
after: types.TestCopyOnWriteMaps#testTailMap Thread=8 (was 8),
OpenFileDescriptor=85 (was 85), MaxFileDescriptor=4096 (was 4096),
SystemLoadAverage=119 (was 104) - SystemLoadAverage LEAK? -, ProcessCount=330
(was 330), AvailableMemoryMB=973 (was 1015), MaxHeapMemoryMB=2489 (was 2489),
UsedHeapMemoryMB=38 (was 21) - UsedHeapMemoryMB LEAK? -, GCCount=4 (was 0) -
GCCount LEAK? -, GCTimeSecond=0 (was 0)
2018-09-12 22:09:24,772 INFO [Time-limited test] hbase.ResourceChecker(148):
before: types.TestCopyOnWriteMaps#testLastEntry Thread=8,
OpenFileDescriptor=85, MaxFileDescriptor=4096, SystemLoadAverage=119,
ProcessCount=330, AvailableMemoryMB=973, MaxHeapMemoryMB=2489,
UsedHeapMemoryMB=38, GCCount=4, GCTimeSecond=0
2018-09-12 22:09:24,842 INFO [Time-limited test] hbase.ResourceChecker(172):
after: types.TestCopyOnWriteMaps#testLastEntry Thread=8 (was 8),
OpenFileDescriptor=85 (was 85), MaxFileDescriptor=4096 (was 4096),
SystemLoadAverage=119 (was 119), ProcessCount=330 (was 330),
AvailableMemoryMB=926 (was 973), MaxHeapMemoryMB=2489 (was 2489),
UsedHeapMemoryMB=44 (was 38) - UsedHeapMemoryMB LEAK? -, GCCount=6 (was 4) -
GCCount LEAK? -, GCTimeSecond=0 (was 0)
2018-09-12 22:09:24,863 INFO [Time-limited test] hbase.ResourceChecker(148):
before: types.TestCopyOnWriteMaps#testFloorKey Thread=8, OpenFileDescriptor=85,
MaxFileDescriptor=4096, SystemLoadAverage=119, ProcessCount=330,
AvailableMemoryMB=926, MaxHeapMemoryMB=2489, UsedHeapMemoryMB=44, GCCount=6,
GCTimeSecond=0
2018-09-12 22:09:24,939 INFO [Time-limited test] hbase.ResourceChecker(172):
after: types.TestCopyOnWriteMaps#testFloorKey Thread=8 (was 8),
OpenFileDescriptor=85 (was 85), MaxFileDescriptor=4096 (was 4096),
SystemLoadAverage=119 (was 119), ProcessCount=330 (was 330),
AvailableMemoryMB=834 (was 926), MaxHeapMemoryMB=2489 (was 2489),
UsedHeapMemoryMB=48 (was 44) - UsedHeapMemoryMB LEAK? -, GCCount=7 (was 6) -
GCCount LEAK? -, GCTimeSecond=0 (was 0)
2018-09-12 22:09:24,950 INFO [Time-limited test] hbase.ResourceChecker(148):
before: types.TestCopyOnWriteMaps#testPut Thread=8, OpenFileDescriptor=85,
MaxFileDescriptor=4096, SystemLoadAverage=119, ProcessCount=330,
AvailableMemoryMB=833, MaxHeapMemoryMB=2489, UsedHeapMemoryMB=48, GCCount=7,
GCTimeSecond=0
2018-09-12 22:09:24,995 INFO [Time-limited test] hbase.ResourceChecker(172):
after: types.TestCopyOnWriteMaps#testPut Thread=8 (was 8),
OpenFileDescriptor=85 (was 85), MaxFileDescriptor=4096 (was 4096),
SystemLoadAverage=119 (was 119), ProcessCount=330 (was 330),
AvailableMemoryMB=832 (was 833), MaxHeapMemoryMB=2489 (was 2489),
UsedHeapMemoryMB=55 (was 48) - UsedHeapMemoryMB LEAK? -, GCCount=8 (was 7) -
GCCount LEAK? -, GCTimeSecond=0 (was 0)
2018-09-12 22:09:25,009 INFO [Time-limited test] hbase.ResourceChecker(148):
before: types.TestCopyOnWriteMaps#testFindOnEmpty Thread=8,
OpenFileDescriptor=85, MaxFileDescriptor=4096, SystemLoadAverage=119,
ProcessCount=330, AvailableMemoryMB=832, MaxHeapMemoryMB=2489,
UsedHeapMemoryMB=57, GCCount=8, GCTimeSecond=0
2018-09-12 22:09:25,074 INFO [Time-limited test] hbase.ResourceChecker(172):
after: types.TestCopyOnWriteMaps#testFindOnEmpty Thread=8 (was 8),
OpenFileDescriptor=85 (was 85), MaxFileDescriptor=4096 (was 4096),
SystemLoadAverage=119 (was 119), ProcessCount=330 (was 330),
AvailableMemoryMB=786 (was 832), MaxHeapMemoryMB=2489 (was 2489),
UsedHeapMemoryMB=245 (was 57) - UsedHeapMemoryMB LEAK? -, GCCount=8 (was 8),
GCTimeSecond=0 (was 0)
2018-09-12 22:09:25,088 INFO [Time-limited test] hbase.ResourceChecker(148):
before: types.TestCopyOnWriteMaps#testKeys Thread=8, OpenFileDescriptor=85,
MaxFileDescriptor=4096, SystemLoadAverage=119, ProcessCount=330,
AvailableMemoryMB=786, MaxHeapMemoryMB=2489, UsedHeapMemoryMB=245, GCCount=8,
GCTimeSecond=0
2018-09-12 22:09:25,219 INFO [Time-limited test] hbase.ResourceChecker(172):
after: types.TestCopyOnWriteMaps#testKeys Thread=8 (was 8),
OpenFileDescriptor=85 (was 85), MaxFileDescriptor=4096 (was 4096),
SystemLoadAverage=119 (was 119), ProcessCount=330 (was 330),
AvailableMemoryMB=645 (was 786), MaxHeapMemoryMB=2489 (was 2489),
UsedHeapMemoryMB=251 (was 245) - UsedHeapMemoryMB LEAK? -, GCCount=9 (was 8) -
GCCount LEAK? -, GCTimeSecond=0 (was 0)
2018-09-12 22:09:25,230 INFO [Time-limited test]
