builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-069 starttime: 1448635653.27 results: success (0) buildid: 20151127060814 builduid: abc686468f0747af9fa342c65131b86d revision: 958669938c10f37112896f1f47e8ed8074c1495d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.270041) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.270545) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.270864) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006484 basedir: '/builds/slave/test' ========= master_lag: 0.03 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.312284) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.312919) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.412713) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.412991) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004628 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.477718) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.478007) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.478376) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.478675) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-27 06:47:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 222M=0s 2015-11-27 06:47:35 (222 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.194752 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.689100) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.689438) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013865 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.740925) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:33.741335) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 958669938c10f37112896f1f47e8ed8074c1495d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 958669938c10f37112896f1f47e8ed8074c1495d --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-27 06:47:35,504 truncating revision to first 12 chars 2015-11-27 06:47:35,504 Setting DEBUG logging. 2015-11-27 06:47:35,504 attempt 1/10 2015-11-27 06:47:35,505 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/958669938c10?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-27 06:47:35,861 unpacking tar archive at: fx-team-958669938c10/testing/mozharness/ program finished with exit code 0 elapsedTime=0.623075 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:34.379110) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:34.379489) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:34.388467) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:34.388837) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-27 06:47:34.389338) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 25 secs) (at 2015-11-27 06:47:34.389675) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--system-bits', '64', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 06:47:36 INFO - MultiFileLogger online at 20151127 06:47:36 in /builds/slave/test 06:47:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --system-bits 64 --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 06:47:36 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 06:47:36 INFO - {'append_to_log': False, 06:47:36 INFO - 'base_work_dir': '/builds/slave/test', 06:47:36 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 06:47:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 06:47:36 INFO - 'branch': 'Fx-Team-Non-PGO', 06:47:36 INFO - 'buildbot_json_path': 'buildprops.json', 06:47:36 INFO - 'config_files': ('talos/linux_config.py',), 06:47:36 INFO - 'default_actions': ('clobber', 06:47:36 INFO - 'read-buildbot-config', 06:47:36 INFO - 'download-and-extract', 06:47:36 INFO - 'populate-webroot', 06:47:36 INFO - 'create-virtualenv', 06:47:36 INFO - 'install', 06:47:36 INFO - 'run-tests'), 06:47:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 06:47:36 INFO - 'download_minidump_stackwalk': True, 06:47:36 INFO - 'download_symbols': 'ondemand', 06:47:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 06:47:36 INFO - 'tooltool.py': '/tools/tooltool.py', 06:47:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 06:47:36 INFO - '/tools/misc-python/virtualenv.py')}, 06:47:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 06:47:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 06:47:36 INFO - 'installer_path': 'installer.exe', 06:47:36 INFO - 'log_level': 'info', 06:47:36 INFO - 'log_name': 'talos', 06:47:36 INFO - 'log_to_console': True, 06:47:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 06:47:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 06:47:36 INFO - 'opt_config_files': (), 06:47:36 INFO - 'pip_index': False, 06:47:36 INFO - 'sps_profile': False, 06:47:36 INFO - 'sps_profile_interval': 0, 06:47:36 INFO - 'suite': 'dromaeojs', 06:47:36 INFO - 'system_bits': '64', 06:47:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 06:47:36 INFO - 'title': 'talos-linux64-ix-069', 06:47:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 06:47:36 INFO - 'use_talos_json': True, 06:47:36 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 06:47:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 06:47:36 INFO - 'work_dir': 'build'} 06:47:36 INFO - ##### 06:47:36 INFO - ##### Running clobber step. 06:47:36 INFO - ##### 06:47:36 INFO - Running pre-action listener: _resource_record_pre_action 06:47:36 INFO - Running main action method: clobber 06:47:36 INFO - rmtree: /builds/slave/test/build 06:47:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 06:47:37 INFO - Running post-action listener: _resource_record_post_action 06:47:37 INFO - ##### 06:47:37 INFO - ##### Running read-buildbot-config step. 06:47:37 INFO - ##### 06:47:37 INFO - Running pre-action listener: _resource_record_pre_action 06:47:37 INFO - Running main action method: read_buildbot_config 06:47:37 INFO - Using buildbot properties: 06:47:37 INFO - { 06:47:37 INFO - "properties": { 06:47:37 INFO - "buildnumber": 938, 06:47:37 INFO - "product": "firefox", 06:47:37 INFO - "script_repo_revision": "production", 06:47:37 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 06:47:37 INFO - "repository": "", 06:47:37 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 06:47:37 INFO - "buildid": "20151127060814", 06:47:37 INFO - "slavename": "talos-linux64-ix-069", 06:47:37 INFO - "pgo_build": "False", 06:47:37 INFO - "basedir": "/builds/slave/test", 06:47:37 INFO - "project": "", 06:47:37 INFO - "platform": "ubuntu64_hw", 06:47:37 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 06:47:37 INFO - "slavebuilddir": "test", 06:47:37 INFO - "scheduler": "tests-fx-team-linux64-talos", 06:47:37 INFO - "branch": "fx-team", 06:47:37 INFO - "repo_path": "integration/fx-team", 06:47:37 INFO - "stage_platform": "linux64", 06:47:37 INFO - "builduid": "abc686468f0747af9fa342c65131b86d", 06:47:37 INFO - "revision": "958669938c10f37112896f1f47e8ed8074c1495d" 06:47:37 INFO - }, 06:47:37 INFO - "sourcestamp": { 06:47:37 INFO - "repository": "", 06:47:37 INFO - "hasPatch": false, 06:47:37 INFO - "project": "", 06:47:37 INFO - "branch": "fx-team-linux64-talos", 06:47:37 INFO - "changes": [ 06:47:37 INFO - { 06:47:37 INFO - "category": null, 06:47:37 INFO - "files": [ 06:47:37 INFO - { 06:47:37 INFO - "url": null, 06:47:37 INFO - "name": "https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 06:47:37 INFO - } 06:47:37 INFO - ], 06:47:37 INFO - "repository": "", 06:47:37 INFO - "rev": "958669938c10f37112896f1f47e8ed8074c1495d", 06:47:37 INFO - "who": "mdeboer@mozilla.com", 06:47:37 INFO - "when": 1448635606, 06:47:37 INFO - "number": 6714985, 06:47:37 INFO - "comments": "Bug 1225832: fix UITour unit tests for Loop without navigator.mozLoop present. r=Standard8", 06:47:37 INFO - "project": "", 06:47:37 INFO - "at": "Fri 27 Nov 2015 06:46:46", 06:47:37 INFO - "branch": "fx-team-linux64-talos", 06:47:37 INFO - "revlink": "", 06:47:37 INFO - "properties": [ 06:47:37 INFO - [ 06:47:37 INFO - "buildid", 06:47:37 INFO - "20151127060814", 06:47:37 INFO - "Change" 06:47:37 INFO - ], 06:47:37 INFO - [ 06:47:37 INFO - "builduid", 06:47:37 INFO - "abc686468f0747af9fa342c65131b86d", 06:47:37 INFO - "Change" 06:47:37 INFO - ], 06:47:37 INFO - [ 06:47:37 INFO - "pgo_build", 06:47:37 INFO - "False", 06:47:37 INFO - "Change" 06:47:37 INFO - ] 06:47:37 INFO - ], 06:47:37 INFO - "revision": "958669938c10f37112896f1f47e8ed8074c1495d" 06:47:37 INFO - } 06:47:37 INFO - ], 06:47:37 INFO - "revision": "958669938c10f37112896f1f47e8ed8074c1495d" 06:47:37 INFO - } 06:47:37 INFO - } 06:47:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 06:47:37 INFO - Running post-action listener: _resource_record_post_action 06:47:37 INFO - ##### 06:47:37 INFO - ##### Running download-and-extract step. 06:47:37 INFO - ##### 06:47:37 INFO - Running pre-action listener: _resource_record_pre_action 06:47:37 INFO - Running main action method: download_and_extract 06:47:37 INFO - mkdir: /builds/slave/test/build/tests 06:47:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:47:37 INFO - https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 06:47:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/test_packages.json 06:47:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/test_packages.json 06:47:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 06:47:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 06:47:43 INFO - Downloaded 1302 bytes. 06:47:43 INFO - Reading from file /builds/slave/test/build/test_packages.json 06:47:43 INFO - Using the following test package requirements: 06:47:43 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 06:47:43 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 06:47:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 06:47:43 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 06:47:43 INFO - u'jsshell-linux-x86_64.zip'], 06:47:43 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 06:47:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 06:47:43 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 06:47:43 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 06:47:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 06:47:43 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 06:47:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 06:47:43 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 06:47:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 06:47:43 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 06:47:43 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 06:47:43 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 06:47:43 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 06:47:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:47:43 INFO - https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:47:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:47:55 INFO - Downloaded 21518599 bytes. 06:47:55 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 06:47:55 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:55 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 06:47:56 INFO - Return code: 0 06:47:56 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 06:47:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:47:56 INFO - https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 06:47:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 06:47:57 INFO - Downloaded 21518599 bytes. 06:47:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 06:47:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 06:47:57 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 06:47:59 INFO - Return code: 0 06:47:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:47:59 INFO - https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 06:47:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 06:47:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 06:47:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 06:47:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 06:48:00 INFO - Downloaded 11131728 bytes. 06:48:00 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 06:48:00 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 06:48:00 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 06:48:00 INFO - Return code: 0 06:48:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:00 INFO - https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 06:48:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 06:48:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 06:48:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 06:48:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 06:48:01 INFO - Downloaded 56877606 bytes. 06:48:01 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 06:48:01 INFO - mkdir: /builds/slave/test/properties 06:48:01 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 06:48:01 INFO - Writing to file /builds/slave/test/properties/build_url 06:48:01 INFO - Contents: 06:48:01 INFO - build_url:https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 06:48:01 INFO - Running post-action listener: _resource_record_post_action 06:48:01 INFO - Running post-action listener: set_extra_try_arguments 06:48:01 INFO - ##### 06:48:01 INFO - ##### Running populate-webroot step. 06:48:01 INFO - ##### 06:48:01 INFO - Running pre-action listener: _resource_record_pre_action 06:48:01 INFO - Running main action method: populate_webroot 06:48:01 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 06:48:01 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 06:48:01 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 06:48:01 INFO - '../fennec_ids.txt'], 06:48:01 INFO - 'tests': ['tcheck2']}, 06:48:01 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 06:48:01 INFO - '--tppagecycles', 06:48:01 INFO - '7'], 06:48:01 INFO - 'tests': ['tsvgm']}}, 06:48:01 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 06:48:01 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['tresize', 'tcanvasmark']}, 06:48:01 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 06:48:01 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 06:48:01 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:48:01 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 06:48:01 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'tests': ['damp', 'tps']}, 06:48:01 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['damp', 'tps']}, 06:48:01 INFO - 'g3': {'tests': ['dromaeo_dom']}, 06:48:01 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 06:48:01 INFO - 'other': {'tests': ['a11yr', 06:48:01 INFO - 'ts_paint', 06:48:01 INFO - 'tpaint', 06:48:01 INFO - 'sessionrestore', 06:48:01 INFO - 'sessionrestore_no_auto_restore']}, 06:48:01 INFO - 'other-e10s': {'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['a11yr', 06:48:01 INFO - 'ts_paint', 06:48:01 INFO - 'tpaint', 06:48:01 INFO - 'sessionrestore', 06:48:01 INFO - 'sessionrestore_no_auto_restore']}, 06:48:01 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['a11yr', 06:48:01 INFO - 'ts_paint', 06:48:01 INFO - 'tpaint', 06:48:01 INFO - 'sessionrestore', 06:48:01 INFO - 'sessionrestore_no_auto_restore']}, 06:48:01 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['a11yr', 06:48:01 INFO - 'ts_paint', 06:48:01 INFO - 'tpaint', 06:48:01 INFO - 'sessionrestore', 06:48:01 INFO - 'sessionrestore_no_auto_restore']}, 06:48:01 INFO - 'other_l64': {'tests': ['a11yr', 06:48:01 INFO - 'ts_paint', 06:48:01 INFO - 'tpaint', 06:48:01 INFO - 'sessionrestore', 06:48:01 INFO - 'sessionrestore_no_auto_restore']}, 06:48:01 INFO - 'other_nol64': {'tests': ['a11yr', 06:48:01 INFO - 'ts_paint', 06:48:01 INFO - 'tpaint', 06:48:01 INFO - 'sessionrestore', 06:48:01 INFO - 'sessionrestore_no_auto_restore']}, 06:48:01 INFO - 'svgr': {'tests': ['tsvgx', 06:48:01 INFO - 'tsvgr_opacity', 06:48:01 INFO - 'tart', 06:48:01 INFO - 'tscrollx', 06:48:01 INFO - 'cart']}, 06:48:01 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['tsvgx', 06:48:01 INFO - 'tsvgr_opacity', 06:48:01 INFO - 'tart', 06:48:01 INFO - 'tscrollx', 06:48:01 INFO - 'cart']}, 06:48:01 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'tests': ['tp5o']}, 06:48:01 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'talos_options': ['--e10s'], 06:48:01 INFO - 'tests': ['tp5o']}, 06:48:01 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'talos_options': ['--xperf_path', 06:48:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:48:01 INFO - 'tests': ['tp5n']}, 06:48:01 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 06:48:01 INFO - 'talos_options': ['--e10s', 06:48:01 INFO - '--xperf_path', 06:48:01 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 06:48:01 INFO - 'tests': ['tp5n']}}, 06:48:01 INFO - 'talos.zip': {'path': '', 06:48:01 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 06:48:01 INFO - Running post-action listener: _resource_record_post_action 06:48:01 INFO - ##### 06:48:01 INFO - ##### Running create-virtualenv step. 06:48:01 INFO - ##### 06:48:01 INFO - Running pre-action listener: _resource_record_pre_action 06:48:01 INFO - Running main action method: create_virtualenv 06:48:01 INFO - Creating virtualenv /builds/slave/test/build/venv 06:48:01 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 06:48:01 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 06:48:01 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 06:48:01 INFO - Using real prefix '/usr' 06:48:01 INFO - New python executable in /builds/slave/test/build/venv/bin/python 06:48:02 INFO - Installing distribute.............................................................................................................................................................................................done. 06:48:04 INFO - Installing pip.................done. 06:48:04 INFO - Return code: 0 06:48:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 06:48:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 06:48:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 06:48:04 INFO - Using env: {'DISPLAY': ':0', 06:48:04 INFO - 'HOME': '/home/cltbld', 06:48:04 INFO - 'LANG': 'en_US.UTF-8', 06:48:04 INFO - 'LANGUAGE': 'en_US:en', 06:48:04 INFO - 'LOGNAME': 'cltbld', 06:48:04 INFO - 'MAIL': '/var/mail/cltbld', 06:48:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:04 INFO - 'MOZ_NO_REMOTE': '1', 06:48:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:04 INFO - 'NO_EM_RESTART': '1', 06:48:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:04 INFO - 'PWD': '/builds/slave/test', 06:48:04 INFO - 'SHELL': '/bin/bash', 06:48:04 INFO - 'SHLVL': '1', 06:48:04 INFO - 'TERM': 'linux', 06:48:04 INFO - 'TMOUT': '86400', 06:48:04 INFO - 'USER': 'cltbld', 06:48:04 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:04 INFO - '_': '/tools/buildbot/bin/python'} 06:48:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:04 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 06:48:04 INFO - Cleaning up... 06:48:04 INFO - Return code: 0 06:48:04 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 06:48:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 06:48:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 06:48:04 INFO - Using env: {'DISPLAY': ':0', 06:48:04 INFO - 'HOME': '/home/cltbld', 06:48:04 INFO - 'LANG': 'en_US.UTF-8', 06:48:04 INFO - 'LANGUAGE': 'en_US:en', 06:48:04 INFO - 'LOGNAME': 'cltbld', 06:48:04 INFO - 'MAIL': '/var/mail/cltbld', 06:48:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:04 INFO - 'MOZ_NO_REMOTE': '1', 06:48:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:04 INFO - 'NO_EM_RESTART': '1', 06:48:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:04 INFO - 'PWD': '/builds/slave/test', 06:48:04 INFO - 'SHELL': '/bin/bash', 06:48:04 INFO - 'SHLVL': '1', 06:48:04 INFO - 'TERM': 'linux', 06:48:04 INFO - 'TMOUT': '86400', 06:48:04 INFO - 'USER': 'cltbld', 06:48:04 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:04 INFO - '_': '/tools/buildbot/bin/python'} 06:48:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:04 INFO - Downloading/unpacking psutil>=0.7.1 06:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:06 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 06:48:06 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 06:48:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 06:48:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:48:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:48:06 INFO - Installing collected packages: psutil 06:48:06 INFO - Running setup.py install for psutil 06:48:06 INFO - building 'psutil._psutil_linux' extension 06:48:06 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 06:48:06 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 06:48:06 INFO - building 'psutil._psutil_posix' extension 06:48:06 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 06:48:06 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 06:48:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 06:48:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 06:48:06 INFO - Successfully installed psutil 06:48:06 INFO - Cleaning up... 06:48:07 INFO - Return code: 0 06:48:07 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 06:48:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 06:48:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 06:48:07 INFO - Using env: {'DISPLAY': ':0', 06:48:07 INFO - 'HOME': '/home/cltbld', 06:48:07 INFO - 'LANG': 'en_US.UTF-8', 06:48:07 INFO - 'LANGUAGE': 'en_US:en', 06:48:07 INFO - 'LOGNAME': 'cltbld', 06:48:07 INFO - 'MAIL': '/var/mail/cltbld', 06:48:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:07 INFO - 'MOZ_NO_REMOTE': '1', 06:48:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:07 INFO - 'NO_EM_RESTART': '1', 06:48:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:07 INFO - 'PWD': '/builds/slave/test', 06:48:07 INFO - 'SHELL': '/bin/bash', 06:48:07 INFO - 'SHLVL': '1', 06:48:07 INFO - 'TERM': 'linux', 06:48:07 INFO - 'TMOUT': '86400', 06:48:07 INFO - 'USER': 'cltbld', 06:48:07 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:07 INFO - '_': '/tools/buildbot/bin/python'} 06:48:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:07 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 06:48:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:08 INFO - Downloading mozsystemmonitor-0.0.tar.gz 06:48:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 06:48:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 06:48:08 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 06:48:08 INFO - Installing collected packages: mozsystemmonitor 06:48:08 INFO - Running setup.py install for mozsystemmonitor 06:48:09 INFO - Successfully installed mozsystemmonitor 06:48:09 INFO - Cleaning up... 06:48:09 INFO - Return code: 0 06:48:09 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 06:48:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 06:48:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 06:48:09 INFO - Using env: {'DISPLAY': ':0', 06:48:09 INFO - 'HOME': '/home/cltbld', 06:48:09 INFO - 'LANG': 'en_US.UTF-8', 06:48:09 INFO - 'LANGUAGE': 'en_US:en', 06:48:09 INFO - 'LOGNAME': 'cltbld', 06:48:09 INFO - 'MAIL': '/var/mail/cltbld', 06:48:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:09 INFO - 'MOZ_NO_REMOTE': '1', 06:48:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:09 INFO - 'NO_EM_RESTART': '1', 06:48:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:09 INFO - 'PWD': '/builds/slave/test', 06:48:09 INFO - 'SHELL': '/bin/bash', 06:48:09 INFO - 'SHLVL': '1', 06:48:09 INFO - 'TERM': 'linux', 06:48:09 INFO - 'TMOUT': '86400', 06:48:09 INFO - 'USER': 'cltbld', 06:48:09 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:09 INFO - '_': '/tools/buildbot/bin/python'} 06:48:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:09 INFO - Downloading/unpacking blobuploader==1.2.4 06:48:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:10 INFO - Downloading blobuploader-1.2.4.tar.gz 06:48:10 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 06:48:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 06:48:11 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 06:48:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 06:48:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 06:48:11 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 06:48:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:11 INFO - Downloading docopt-0.6.1.tar.gz 06:48:11 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 06:48:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 06:48:11 INFO - Installing collected packages: blobuploader, requests, docopt 06:48:11 INFO - Running setup.py install for blobuploader 06:48:11 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 06:48:11 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 06:48:11 INFO - Running setup.py install for requests 06:48:12 INFO - Running setup.py install for docopt 06:48:12 INFO - Successfully installed blobuploader requests docopt 06:48:12 INFO - Cleaning up... 06:48:12 INFO - Return code: 0 06:48:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:48:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:48:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:48:12 INFO - Using env: {'DISPLAY': ':0', 06:48:12 INFO - 'HOME': '/home/cltbld', 06:48:12 INFO - 'LANG': 'en_US.UTF-8', 06:48:12 INFO - 'LANGUAGE': 'en_US:en', 06:48:12 INFO - 'LOGNAME': 'cltbld', 06:48:12 INFO - 'MAIL': '/var/mail/cltbld', 06:48:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:12 INFO - 'MOZ_NO_REMOTE': '1', 06:48:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:12 INFO - 'NO_EM_RESTART': '1', 06:48:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:12 INFO - 'PWD': '/builds/slave/test', 06:48:12 INFO - 'SHELL': '/bin/bash', 06:48:12 INFO - 'SHLVL': '1', 06:48:12 INFO - 'TERM': 'linux', 06:48:12 INFO - 'TMOUT': '86400', 06:48:12 INFO - 'USER': 'cltbld', 06:48:12 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:12 INFO - '_': '/tools/buildbot/bin/python'} 06:48:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:48:12 INFO - Running setup.py (path:/tmp/pip-pbX6xq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:48:12 INFO - Running setup.py (path:/tmp/pip-QOTUlk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:48:12 INFO - Running setup.py (path:/tmp/pip-Ak4xnx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:48:12 INFO - Running setup.py (path:/tmp/pip-L5vikr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:48:12 INFO - Running setup.py (path:/tmp/pip-xedF8U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:48:12 INFO - Running setup.py (path:/tmp/pip-VucDKs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:48:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:48:12 INFO - Running setup.py (path:/tmp/pip-OQc5sy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:48:13 INFO - Running setup.py (path:/tmp/pip-S9zqbG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:48:13 INFO - Running setup.py (path:/tmp/pip-qOuhDz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:48:13 INFO - Running setup.py (path:/tmp/pip-CL00k7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:48:13 INFO - Running setup.py (path:/tmp/pip-FFbxcw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:48:13 INFO - Running setup.py (path:/tmp/pip-mScABV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:48:13 INFO - Running setup.py (path:/tmp/pip-E6qmnM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:48:13 INFO - Running setup.py (path:/tmp/pip-njrHIZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:13 INFO - Running setup.py (path:/tmp/pip-wYrVwt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:48:13 INFO - Running setup.py (path:/tmp/pip-K0Oyey-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:48:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:48:13 INFO - Running setup.py (path:/tmp/pip-uLaF2c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:48:13 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 06:48:13 INFO - Running setup.py install for manifestparser 06:48:13 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 06:48:13 INFO - Running setup.py install for mozcrash 06:48:13 INFO - Running setup.py install for mozdebug 06:48:14 INFO - Running setup.py install for mozdevice 06:48:14 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Installing dm script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Running setup.py install for mozfile 06:48:14 INFO - Running setup.py install for mozhttpd 06:48:14 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Running setup.py install for mozinfo 06:48:14 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Running setup.py install for mozInstall 06:48:14 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Running setup.py install for mozleak 06:48:14 INFO - Running setup.py install for mozlog 06:48:14 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Running setup.py install for moznetwork 06:48:14 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 06:48:14 INFO - Running setup.py install for mozprocess 06:48:14 INFO - Running setup.py install for mozprofile 06:48:15 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 06:48:15 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 06:48:15 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 06:48:15 INFO - Running setup.py install for mozrunner 06:48:15 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 06:48:15 INFO - Running setup.py install for mozscreenshot 06:48:15 INFO - Running setup.py install for moztest 06:48:15 INFO - Running setup.py install for mozversion 06:48:15 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 06:48:15 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 06:48:15 INFO - Cleaning up... 06:48:15 INFO - Return code: 0 06:48:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:48:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 06:48:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:48:15 INFO - Using env: {'DISPLAY': ':0', 06:48:15 INFO - 'HOME': '/home/cltbld', 06:48:15 INFO - 'LANG': 'en_US.UTF-8', 06:48:15 INFO - 'LANGUAGE': 'en_US:en', 06:48:15 INFO - 'LOGNAME': 'cltbld', 06:48:15 INFO - 'MAIL': '/var/mail/cltbld', 06:48:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:15 INFO - 'MOZ_NO_REMOTE': '1', 06:48:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:15 INFO - 'NO_EM_RESTART': '1', 06:48:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:15 INFO - 'PWD': '/builds/slave/test', 06:48:15 INFO - 'SHELL': '/bin/bash', 06:48:15 INFO - 'SHLVL': '1', 06:48:15 INFO - 'TERM': 'linux', 06:48:15 INFO - 'TMOUT': '86400', 06:48:15 INFO - 'USER': 'cltbld', 06:48:15 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:15 INFO - '_': '/tools/buildbot/bin/python'} 06:48:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 06:48:15 INFO - Running setup.py (path:/tmp/pip-93EiY6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 06:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 06:48:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 06:48:15 INFO - Running setup.py (path:/tmp/pip-nwGZq2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 06:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:48:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 06:48:15 INFO - Running setup.py (path:/tmp/pip-gqEDm8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 06:48:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 06:48:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 06:48:15 INFO - Running setup.py (path:/tmp/pip-fZD2om-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.47 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 06:48:16 INFO - Running setup.py (path:/tmp/pip-q25CAN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 06:48:16 INFO - Running setup.py (path:/tmp/pip-NF2CzK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 06:48:16 INFO - Running setup.py (path:/tmp/pip-2sdybm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 06:48:16 INFO - Running setup.py (path:/tmp/pip-JLARfj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 06:48:16 INFO - Running setup.py (path:/tmp/pip-XhHYxU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 06:48:16 INFO - Running setup.py (path:/tmp/pip-hn_C2b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 06:48:16 INFO - Running setup.py (path:/tmp/pip-2FdfLQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 06:48:16 INFO - Running setup.py (path:/tmp/pip-UnoCfJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 06:48:16 INFO - Running setup.py (path:/tmp/pip-okQucE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.27 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 06:48:16 INFO - Running setup.py (path:/tmp/pip-e3eglm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:16 INFO - Running setup.py (path:/tmp/pip-4cCsxR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 06:48:16 INFO - Running setup.py (path:/tmp/pip-nLBd7h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 06:48:16 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 06:48:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 06:48:16 INFO - Running setup.py (path:/tmp/pip-B1AoSD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 06:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 06:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 06:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 06:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:48:17 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.47->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 06:48:17 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 06:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:18 INFO - Downloading blessings-1.5.1.tar.gz 06:48:18 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 06:48:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 06:48:18 INFO - Installing collected packages: blessings 06:48:18 INFO - Running setup.py install for blessings 06:48:18 INFO - Successfully installed blessings 06:48:18 INFO - Cleaning up... 06:48:18 INFO - Return code: 0 06:48:18 INFO - Done creating virtualenv /builds/slave/test/build/venv. 06:48:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:48:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:48:19 INFO - Reading from file tmpfile_stdout 06:48:19 INFO - Current package versions: 06:48:19 INFO - argparse == 1.2.1 06:48:19 INFO - blessings == 1.5.1 06:48:19 INFO - blobuploader == 1.2.4 06:48:19 INFO - docopt == 0.6.1 06:48:19 INFO - manifestparser == 1.1 06:48:19 INFO - mozInstall == 1.12 06:48:19 INFO - mozcrash == 0.16 06:48:19 INFO - mozdebug == 0.1 06:48:19 INFO - mozdevice == 0.47 06:48:19 INFO - mozfile == 1.2 06:48:19 INFO - mozhttpd == 0.7 06:48:19 INFO - mozinfo == 0.9 06:48:19 INFO - mozleak == 0.1 06:48:19 INFO - mozlog == 3.1 06:48:19 INFO - moznetwork == 0.27 06:48:19 INFO - mozprocess == 0.22 06:48:19 INFO - mozprofile == 0.27 06:48:19 INFO - mozrunner == 6.11 06:48:19 INFO - mozscreenshot == 0.1 06:48:19 INFO - mozsystemmonitor == 0.0 06:48:19 INFO - moztest == 0.7 06:48:19 INFO - mozversion == 1.4 06:48:19 INFO - psutil == 3.1.1 06:48:19 INFO - requests == 1.2.3 06:48:19 INFO - wsgiref == 0.1.2 06:48:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 06:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 06:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 06:48:19 INFO - Using env: {'DISPLAY': ':0', 06:48:19 INFO - 'HOME': '/home/cltbld', 06:48:19 INFO - 'LANG': 'en_US.UTF-8', 06:48:19 INFO - 'LANGUAGE': 'en_US:en', 06:48:19 INFO - 'LOGNAME': 'cltbld', 06:48:19 INFO - 'MAIL': '/var/mail/cltbld', 06:48:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:19 INFO - 'MOZ_NO_REMOTE': '1', 06:48:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:19 INFO - 'NO_EM_RESTART': '1', 06:48:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:19 INFO - 'PWD': '/builds/slave/test', 06:48:19 INFO - 'SHELL': '/bin/bash', 06:48:19 INFO - 'SHLVL': '1', 06:48:19 INFO - 'TERM': 'linux', 06:48:19 INFO - 'TMOUT': '86400', 06:48:19 INFO - 'USER': 'cltbld', 06:48:19 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:19 INFO - '_': '/tools/buildbot/bin/python'} 06:48:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 06:48:19 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.0->mozcrash>=0.15->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 06:48:19 INFO - Cleaning up... 06:48:19 INFO - Return code: 0 06:48:19 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 06:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:19 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:19 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 06:48:19 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 06:48:19 INFO - Using env: {'DISPLAY': ':0', 06:48:19 INFO - 'HOME': '/home/cltbld', 06:48:19 INFO - 'LANG': 'en_US.UTF-8', 06:48:19 INFO - 'LANGUAGE': 'en_US:en', 06:48:19 INFO - 'LOGNAME': 'cltbld', 06:48:19 INFO - 'MAIL': '/var/mail/cltbld', 06:48:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:19 INFO - 'MOZ_NO_REMOTE': '1', 06:48:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:19 INFO - 'NO_EM_RESTART': '1', 06:48:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:19 INFO - 'PWD': '/builds/slave/test', 06:48:19 INFO - 'SHELL': '/bin/bash', 06:48:19 INFO - 'SHLVL': '1', 06:48:19 INFO - 'TERM': 'linux', 06:48:19 INFO - 'TMOUT': '86400', 06:48:19 INFO - 'USER': 'cltbld', 06:48:19 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:19 INFO - '_': '/tools/buildbot/bin/python'} 06:48:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:19 INFO - Downloading/unpacking jsonschema 06:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:21 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 06:48:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 06:48:21 INFO - Downloading/unpacking functools32 (from jsonschema) 06:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:21 INFO - Downloading functools32-3.2.3-2.tar.gz 06:48:21 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 06:48:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 06:48:21 INFO - warning: no files found matching '*.txt' 06:48:21 INFO - no previously-included directories found matching 'build' 06:48:21 INFO - no previously-included directories found matching 'dist' 06:48:21 INFO - no previously-included directories found matching '.git*' 06:48:21 INFO - Installing collected packages: jsonschema, functools32 06:48:21 INFO - Running setup.py install for functools32 06:48:21 INFO - warning: no files found matching '*.txt' 06:48:21 INFO - no previously-included directories found matching 'build' 06:48:21 INFO - no previously-included directories found matching 'dist' 06:48:21 INFO - no previously-included directories found matching '.git*' 06:48:21 INFO - Successfully installed jsonschema functools32 06:48:21 INFO - Cleaning up... 06:48:21 INFO - Return code: 0 06:48:21 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 06:48:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 06:48:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 06:48:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 06:48:21 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f63c4758f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x115f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x122d240>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 06:48:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 06:48:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 06:48:21 INFO - Using env: {'DISPLAY': ':0', 06:48:21 INFO - 'HOME': '/home/cltbld', 06:48:21 INFO - 'LANG': 'en_US.UTF-8', 06:48:21 INFO - 'LANGUAGE': 'en_US:en', 06:48:21 INFO - 'LOGNAME': 'cltbld', 06:48:21 INFO - 'MAIL': '/var/mail/cltbld', 06:48:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:21 INFO - 'MOZ_NO_REMOTE': '1', 06:48:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:21 INFO - 'NO_EM_RESTART': '1', 06:48:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:21 INFO - 'PWD': '/builds/slave/test', 06:48:21 INFO - 'SHELL': '/bin/bash', 06:48:21 INFO - 'SHLVL': '1', 06:48:21 INFO - 'TERM': 'linux', 06:48:21 INFO - 'TMOUT': '86400', 06:48:21 INFO - 'USER': 'cltbld', 06:48:21 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:21 INFO - '_': '/tools/buildbot/bin/python'} 06:48:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 06:48:21 INFO - Downloading/unpacking flake8 06:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:21 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:21 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:21 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:21 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:23 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 06:48:23 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 06:48:23 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 06:48:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:23 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 06:48:23 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 06:48:23 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 06:48:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:23 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 06:48:23 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 06:48:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 06:48:23 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 06:48:23 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 06:48:24 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 06:48:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 06:48:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:48:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:48:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:48:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:48:24 INFO - no previously-included directories found matching 'docs/_build' 06:48:24 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 06:48:24 INFO - Running setup.py install for pep8 06:48:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 06:48:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 06:48:24 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 06:48:24 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 06:48:24 INFO - no previously-included directories found matching 'docs/_build' 06:48:24 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 06:48:24 INFO - Successfully installed flake8 mccabe pyflakes pep8 06:48:24 INFO - Cleaning up... 06:48:24 INFO - Return code: 0 06:48:24 INFO - Running post-action listener: _resource_record_post_action 06:48:24 INFO - Running post-action listener: _start_resource_monitoring 06:48:24 INFO - Starting resource monitoring. 06:48:24 INFO - ##### 06:48:24 INFO - ##### Running install step. 06:48:24 INFO - ##### 06:48:24 INFO - Running pre-action listener: _resource_record_pre_action 06:48:24 INFO - Running main action method: install 06:48:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 06:48:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 06:48:24 INFO - Reading from file tmpfile_stdout 06:48:24 INFO - Detecting whether we're running mozinstall >=1.0... 06:48:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 06:48:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 06:48:24 INFO - Reading from file tmpfile_stdout 06:48:24 INFO - Output received: 06:48:24 INFO - Usage: mozinstall [options] installer 06:48:24 INFO - Options: 06:48:24 INFO - -h, --help show this help message and exit 06:48:24 INFO - -d DEST, --destination=DEST 06:48:24 INFO - Directory to install application into. [default: 06:48:24 INFO - "/builds/slave/test"] 06:48:24 INFO - --app=APP Application being installed. [default: firefox] 06:48:24 INFO - mkdir: /builds/slave/test/build/application 06:48:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 06:48:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 06:48:39 INFO - Reading from file tmpfile_stdout 06:48:39 INFO - Output received: 06:48:39 INFO - /builds/slave/test/build/application/firefox/firefox 06:48:39 INFO - Running post-action listener: _resource_record_post_action 06:48:39 INFO - ##### 06:48:39 INFO - ##### Running run-tests step. 06:48:39 INFO - ##### 06:48:39 INFO - Running pre-action listener: _resource_record_pre_action 06:48:39 INFO - Running main action method: run_tests 06:48:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 06:48:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 06:48:39 INFO - Python 2.7.3 06:48:39 INFO - Return code: 0 06:48:39 INFO - grabbing minidump binary from tooltool 06:48:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 06:48:39 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bc0b0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12bcfb0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12bd440>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 06:48:39 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 06:48:39 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 06:48:39 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 06:48:39 INFO - Return code: 0 06:48:39 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 06:48:39 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 06:48:39 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 06:48:39 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 06:48:39 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 06:48:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 06:48:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 06:48:40 INFO - Return code: 0 06:48:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--webServer', 'localhost'] in /builds/slave/test/build 06:48:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --debug --branchName Fx-Team-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-069 --webServer localhost 06:48:40 INFO - Using env: {'DISPLAY': ':0', 06:48:40 INFO - 'HOME': '/home/cltbld', 06:48:40 INFO - 'LANG': 'en_US.UTF-8', 06:48:40 INFO - 'LANGUAGE': 'en_US:en', 06:48:40 INFO - 'LOGNAME': 'cltbld', 06:48:40 INFO - 'MAIL': '/var/mail/cltbld', 06:48:40 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 06:48:40 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 06:48:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 06:48:40 INFO - 'MOZ_NO_REMOTE': '1', 06:48:40 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 06:48:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 06:48:40 INFO - 'NO_EM_RESTART': '1', 06:48:40 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 06:48:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 06:48:40 INFO - 'PWD': '/builds/slave/test', 06:48:40 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 06:48:40 INFO - 'SHELL': '/bin/bash', 06:48:40 INFO - 'SHLVL': '1', 06:48:40 INFO - 'TERM': 'linux', 06:48:40 INFO - 'TMOUT': '86400', 06:48:40 INFO - 'USER': 'cltbld', 06:48:40 INFO - 'XDG_SESSION_COOKIE': 'd96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911', 06:48:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 06:48:40 INFO - '_': '/tools/buildbot/bin/python'} 06:48:40 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--debug', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-069', '--webServer', 'localhost'] with output_timeout 3600 06:48:40 INFO - mozversion INFO | application_buildid: 20151127060814 06:48:40 INFO - mozversion INFO | application_changeset: 958669938c10f37112896f1f47e8ed8074c1495d 06:48:40 INFO - mozversion INFO | application_display_name: Nightly 06:48:40 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 06:48:40 INFO - mozversion INFO | application_name: Firefox 06:48:40 INFO - mozversion INFO | application_remotingname: firefox 06:48:40 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 06:48:40 INFO - mozversion INFO | application_vendor: Mozilla 06:48:40 INFO - mozversion INFO | application_version: 45.0a1 06:48:40 INFO - mozversion INFO | platform_buildid: 20151127060814 06:48:40 INFO - mozversion INFO | platform_changeset: 958669938c10f37112896f1f47e8ed8074c1495d 06:48:40 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 06:48:40 INFO - mozversion INFO | platform_version: 45.0a1 06:48:40 INFO - 2015-11-27 06:48:40,292 DEBUG : using testdate: 1448635720 06:48:40 INFO - 2015-11-27 06:48:40,292 DEBUG : actual date: 1448635720 06:48:40 INFO - 2015-11-27 06:48:40,350 INFO : starting webserver on 'localhost:50666' 06:48:40 INFO - 2015-11-27 06:48:40,351 INFO : Starting test suite talos-linux64-ix-069 06:48:40 INFO - 2015-11-27 06:48:40,351 INFO : Starting test dromaeo_css 06:48:40 INFO - 2015-11-27 06:48:40,351 DEBUG : operating with platform_type : linux_ 06:48:40 INFO - 2015-11-27 06:48:40,352 INFO : Initialising browser for dromaeo_css test... 06:48:40 INFO - 2015-11-27 06:48:40,368 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMgQb1C/profile http://localhost:50666/getInfo.html 06:48:45 INFO - 2015-11-27 06:48:45,001 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 06:48:45 INFO - 2015-11-27 06:48:45,001 DEBUG : BROWSER_OUTPUT: colorDepth:24 06:48:45 INFO - 2015-11-27 06:48:45,001 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 06:48:45 INFO - 2015-11-27 06:48:45,001 DEBUG : BROWSER_OUTPUT: __metrics 06:48:45 INFO - 2015-11-27 06:48:45,219 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 06:48:46 INFO - 2015-11-27 06:48:46,488 INFO : Browser initialized. 06:48:46 INFO - 2015-11-27 06:48:46,488 INFO : Running cycle 1/1 for dromaeo_css test... 06:48:46 INFO - 2015-11-27 06:48:46,488 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMgQb1C/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 06:48:58 INFO - 2015-11-27 06:48:58,431 DEBUG : BROWSER_OUTPUT: RSS: Main: 139550720 06:48:58 INFO - 2015-11-27 06:48:58,431 DEBUG : BROWSER_OUTPUT: 06:49:49 INFO - 2015-11-27 06:49:49,637 DEBUG : BROWSER_OUTPUT: 1448635789635 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 06:52:01 INFO - 2015-11-27 06:52:01,531 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/dromaeo/cssquery-dojo.html (next: http://localhost:50666/tests/dromaeo/cssquery-ext.html) 06:52:02 INFO - 2015-11-27 06:52:02,784 DEBUG : BROWSER_OUTPUT: RSS: Main: 262074368 06:52:02 INFO - 2015-11-27 06:52:02,784 DEBUG : BROWSER_OUTPUT: 06:55:05 INFO - 2015-11-27 06:55:05,449 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/dromaeo/cssquery-ext.html (next: http://localhost:50666/tests/dromaeo/cssquery-jquery.html) 06:55:06 INFO - 2015-11-27 06:55:06,022 DEBUG : BROWSER_OUTPUT: RSS: Main: 225783808 06:55:06 INFO - 2015-11-27 06:55:06,022 DEBUG : BROWSER_OUTPUT: 06:58:08 INFO - 2015-11-27 06:58:08,017 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/dromaeo/cssquery-jquery.html (next: http://localhost:50666/tests/dromaeo/cssquery-mootools.html) 06:58:08 INFO - 2015-11-27 06:58:08,590 DEBUG : BROWSER_OUTPUT: RSS: Main: 228552704 06:58:08 INFO - 2015-11-27 06:58:08,590 DEBUG : BROWSER_OUTPUT: 07:01:10 INFO - 2015-11-27 07:01:10,679 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/dromaeo/cssquery-mootools.html (next: http://localhost:50666/tests/dromaeo/cssquery-prototype.html) 07:01:11 INFO - 2015-11-27 07:01:11,268 DEBUG : BROWSER_OUTPUT: RSS: Main: 205287424 07:01:11 INFO - 2015-11-27 07:01:11,269 DEBUG : BROWSER_OUTPUT: 07:04:14 INFO - 2015-11-27 07:04:14,011 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/dromaeo/cssquery-prototype.html (next: http://localhost:50666/tests/dromaeo/cssquery-yui.html) 07:04:14 INFO - 2015-11-27 07:04:14,604 DEBUG : BROWSER_OUTPUT: RSS: Main: 208318464 07:04:14 INFO - 2015-11-27 07:04:14,604 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,270 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/dromaeo/cssquery-yui.html (next: http://localhost:50666/tests/dromaeo/cssquery-dojo.html) 07:07:17 INFO - 2015-11-27 07:07:17,520 DEBUG : BROWSER_OUTPUT: RSS: Main: 252706816 07:07:17 INFO - 2015-11-27 07:07:17,520 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,522 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:07:17 INFO - 2015-11-27 07:07:17,522 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:07:17 INFO - 2015-11-27 07:07:17,522 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:07:17 INFO - 2015-11-27 07:07:17,522 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:07:17 INFO - 2015-11-27 07:07:17,524 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2610.9216723498294;2698.0287096645206;2708.566629339306;2714.3756935904753;2725.618413422121;4436.401085853408;4594.977025114878;4614.377059097021;4617.168909596276;4656.743879086653;4578.221702310607;4581.289900065487;4672.976635116828;4676.064787042596;4718.952810471894;4292.871213863589;4297.763623000734;4305.3541968704785;4309.052008558112;4324.589164029412;4191.11986482839;4378.255696531582;4382.715123516977;4427.026054268072;4435.179491794029;4190.078182799779;4246.171996460692;4288.742675439484;4290;4314.352847072964;4304.246756817575;4350.456192975878;4357.455318085239;4378.190034843564;4380.2115619188535;4137.751734895915;4317.525072242051;4319.157764235975;4328.761918094504;4364.956350436487;4500.842470513549;4542.432195975503;4549.840755573539;4585.518520555361;4612.331211974279;5010.3737032870895;5012.473690262506;5023.7236951967625;5053.9241911371355;5056.191009438472;4858.101251268491;5023.748812559394;5045.117104506697;5051.1413059779925;5058.0895438821;4517.503074661785;4567.269236922077;4574.4968053514085;4643.024964757371;4655;5145.15105007677;5170.741462926839;5176.844694659167;5179.1454410021925;5184.092783762826;4953.430355509163;4964.528369804862;4969.602431805447;5006.148954677641;5007.12375334315;4836.782344794493;4876.073546026315;4945.134601444733;4949.084419382426;4993.425756038029;4907.263910413467;4917.385326834145;4922.335484709519;4925.359703238556;4972.378452693413;4877.365942427462;4878.390201224847;4881.8535443936735;4895.241237608177;4920.778564964585;4113.526944401372;4169.353750168729;4207.76857272853;4209.431726716854;4210.789460526961;3733.738638295293;3762.6237376262156;3766.8681596144;3767.03940495172;3769.5853456119803;4223.640990515779;4298.4841818981295;4306.612404883575;4313.870583882489;4322.654187664979;5006.4492905780335;5019.67372120811;5023.547880690682;5025.692192566725;5061.291419201315;4298.806553705091;4302.440682711227;4303.225419424471;4307.440032795716;4349.608535231844;4274.7435153890865;4373.693841431069;4377.387165796791;4413.757243351646;4504.009117994036;4810.542998415145;4810.783514741775;4820.807167713322;4839.225723884232;4857.295692124551;4990.850274491771;5078.97460512695;5082.898342033212;5083.923741143812;5088.0587091388215;4573.542645735533;4674.649401294984;4675.696079754805;4705.811767529397;4840.394950631171;4858.514148585114;4875.463698993179;4878.07316609843;4893.363862697826;4940;4928.6057115431395;4938.654294199371;4955.20716685343;4957.950420495749;4961.578265847444;4733.7396443194575;4776.928346074881;4826.855194344175;4834.903301933871;4861.951380486292;4879.56083952446;4886.949623165438;4894.045661096052;4897.167481528078;4926.088673595253;4784.856454306377;4810.086083644096;4811.879703007453;4846.5638092571835;4859.562639362474;4694.155052090657;4780.95219047805;4794.520547945317;4795.760211989456;4905.877353066202;4779.617630589475;4788.449328327287;4789;4825.155597770447;4840.927386089282 07:07:17 INFO - 2015-11-27 07:07:17,527 DEBUG : BROWSER_OUTPUT: |1;ext.html;536.7745546870314;540.0818608365777;556.4657928388747;564.5540023381528;573.8421933968158;27981.300467488323;28492.430151396984;36061.45907811385;36520.26959460809;36535.63464365355;39279.60720392795;39430.43702159358;39528.40707389391;39554.802225988904;39637.8018109909;6924.688389022506;7955.482893611911;8100.635471403772;8139.267465928066;8147.063087744897;7081.89377159343;7143.071400717926;7149.606771627558;7150.463715221354;7165.89251161233;10230.744231394237;10369.118624916853;10374.429406382646;10383.636572719955;10396.116330111912;10049.799004019915;10136.493175341277;10137.797244055151;10139.493025348704;10139.949300253526;7229.132504099489;7398.149212840538;9964.05341492557;10182.898171018269;10439.634612788515;35626.971707404904;35974;35978.64021359779;36010;36118.819405903065;2557.8429223380253;2595.6236345729762;2694.191742477249;2786.3312804926672;3081.6302043754895;27649.447011059867;27763.583546246824;27779.86110069437;28118.578221326698;28221.29446763827;3429.8285085745615;3455.481677748333;3461.671141241578;3471.89584312471;3573.3210689969083;219625;221271;221394.89302553545;221989;223100;48424;49954.75022624864;50005.49994500081;52319.476805232225;52884.471155288724;60756.392436075075;61847;61983.690081549306;62414.68792656008;62506;12337.938310308571;12526.561570344995;12527.436265367898;12530.812037819258;12539.37303134858;8884.600192991331;8890.955545222232;8891.911080889238;8901.554922253861;8926.285897128215;17294.913525432545;17546.473605791845;17658.205380757896;17669.11654417274;17700.20349084294;7317.0366301281565;7608.2391760824585;7639.388848892076;7653.425993050543;7691.961540192263;816.4652152839899;824.9175082491823;906.3112034853427;933.1461712533091;951.3911096897991;25835.354116147246;26178.08376706806;26374.340641484116;26540.46919061608;26573.33566660849;947.9526023698787;957.5547370472624;961.3030552849268;1014.7057353367588;1035.1201478743158;12556.434960426803;12604.180728252633;12606.369681516071;12741.49034038628;13877.167369957835;266177;270051;270205;270515;270781;44419.11161776746;44478.33282500765;44623.55376446194;44692.77653611711;44715.55284447114;1189.714468527547;1190.863050749175;1193.1588230297618;1208.4622343057256;1212.2847519963263;25246.621300680872;26163.73836261613;26431.60352594751;26744.59883101794;26819.597706034034;34530.482042768876;35342;38763.41854872236;39183.2163356737;40546;182075;182675;184244;184521;184722;25460.236192914243;25756.484870302113;25817;25850.095246666275;25874.61188082218;27113.1866044019;30205.546916796706;35151.296974059864;36325.273494529436;36908.630913691595;27919.162425127277;28675.426491470473;29117.12648620545;29139.562906556843;29153.562696559144;28764.280892977007;28976.855115724287;30561.388772223985;32333.838330808194;32739.181520462178;29429;29942.850285749304;30155.849220754633;30161.69838301589;30167.69832301737;26184.607230891932;26301.868490657424;26766;26782.866085669448;27265;22130.336089917328;23066.53866922686;23632.52734945257;24685.50628987446;24963.375915602257 07:07:17 INFO - 2015-11-27 07:07:17,527 DEBUG : BROWSER_OUTPUT: |2;jquery.html;306.68258352605056;315.0516943998564;322.95478632991376;323.88178314915064;324.7191179629621;12392.07059470541;12778.872211277885;14781;15150.318235679393;15291.082535047892;13461.259630720306;13571.253581053039;13572.592822215349;14197.92901035496;14603.123812571253;4270.786460676969;4874.805007799692;5015.974920125394;5019.322391477159;5857.4435428634215;3540.5574303212097;3642.672159505644;5613.410591887854;5736.569757268201;5815.738291776859;5687.374388817227;5710.457506536894;5713.285839270091;5755.136729490568;5765.1352297155345;5583.58123140764;5744.712764361765;5750.482456578907;5758.078707406816;5769.509591684712;5014.52362025607;5015.523525265094;5028.547430731252;5033.672811267256;5037.345145131146;18853.717194242097;19018;19233.519162020923;19398.70901936472;19496.220151193935;1790.185465613143;1816.8455681267108;1848.334599544163;1900.1924182222638;1945.367755479475;12262.26426414418;12620.495180192782;12676.492940282378;12702.555410560586;12730.299833509152;1734.6010417604023;1738.4697667211497;1740.9651806963916;1761.9647607047787;1861.655593715167;50698.7465062676;52743;52944.73527632337;53132;53771.46228537743;9089.909100909039;9220.308476864262;9249.861252081224;9278.396904201205;9294.070592940787;11824.23142495735;11852.585159519376;11869.703257418461;11882.821757673642;11886.108541859396;6550.7707230246715;6556.524781924124;6609.603423794588;6642.269350371455;6652.70062847173;6234.9688251558455;6257.468115210167;6274.498040156868;6318.241810982619;6330.335314791972;5601.411851755588;5638.633488823213;5648.378678345379;5678.801241956594;5688.8862222755315;1488.880889528835;1545.0652355325092;1552.4023251048202;1632.3796957156442;1637.683690526693;319.2784307465099;320.2074864709825;321.44229761364016;328.505599073393;996.3374356053289;7664.31021208094;8708.953395951947;8724.127587241352;8806.163414475615;9212.861807072899;323.54864963375957;335.69749372435285;336.83831760754975;350.9964900351015;362.351391010089;4597.241455159928;4628.305754136906;4697.436307643105;4697.4832768395445;4796.2805579163405;499800;505064;511921;515613;517358.95846249344;70315;71286;72229;72783.63608182031;73088;373.60584583264915;376.30008184776295;376.7118154611724;377.7487970499642;378.3737913752744;8617.396782225183;8640.395172337876;8818.691345803123;8949.59726812282;9091.772705682146;30056;30178.849105754332;31745.8412707935;32042.19894502563;32419.35161296808;42292;43705;43765.78117109394;43803.78098109489;44962.55037449583;7765.534067955715;7914.2085791420395;7914.643841027052;7937.444378893653;8006.759797206093;11892.643220703392;15405.614859628598;16022.919885400499;16085;16089.517314480585;13023.283719395524;13182.340882956005;13201.735965280448;13432.992525560427;13474.124181928144;12828.29444380568;13002.739945201232;13082.28047457399;13245.403956821774;13407.731845362843;10430.634927777492;12235.93882030584;13279.070465067352;13569.86430135686;13848.376823042785;7462.141853686896;7610.391168706379;7617.809554761176;7639.694412223449;7653.88519172224;8042.075161356519;9354.485503297385;12850.164739291917;12989.805152922903;13274.668133296746 07:07:17 INFO - 2015-11-27 07:07:17,529 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1257.377598088945;1566.2638559876857;1616.0465325457985;1642.0804349564253;1646.5060481855444;5606.83179504615;6501.609903405793;6691.765788197414;6707.362800533953;6719.7312107515645;6564.08102865598;6677.031830384592;6702.296258892807;6717.563358381702;6730;1653.9503814885572;1680.731083026716;1886.735856980024;1892;1919.193938545814;1901.2300018492533;1909.0168563189968;1909.551255454974;1909.6849019911767;1910.866239363245;1899.0884375499768;1925.1817977359635;1969.035172765342;1969.1729473621112;1969.2221572478861;1895.071415006637;1903.9333623323187;1930.3919265431343;1934.8065193480609;1939.8739081959698;1934.1876411906892;1952.4825921130912;1953.677643188872;1954.6677064899002;1962.1268535501708;6571.868562628769;6631.1379520662;6637.73449062037;6644.302348253412;6659.33406659335;3626.8549258029648;3664;3670.779753214789;3673.265346930598;3675.1547144156993;2204.3166618348364;2501.399664080626;2522.810789190818;2543.949121017588;2572.0740533407957;750.3134631811886;830.0537387378394;859.2567429173782;888.2893685051997;903.1555495611558;8704.825903481958;8787.868181977276;8789.384743067987;8796.076411976714;8806.075362087016;3480.129967508123;3487.2851065531504;3543.4153364695053;3577.6601222884306;3581.068922080278;7601.619919004138;7616.809579760439;7627.580483073373;7634.427417943676;7640.3505702015955;3748.700103991674;3779.4897688811657;3782.224643947984;3782.867599634;3782.905427364338;3415.077928959167;3425.8629654813526;3451.6375780543185;3452.4130897747445;3457.066592020191;2775.153578158681;2912.8689208985224;2913.140623516068;3170.8414579271407;3172.1118086935694;863.1972265792873;944.6552008516979;996.0885789502669;998.0917365197636;1006.2201793610011;925.509479975614;926.643242351686;962.451402700454;972.2076507646245;1181.5628217559558;6272.968635156795;6341.8097457076365;6346.650934198663;6347.96826015867;6354.17395738551;990.1732053735068;998.960041598328;1010.7068950004416;1019.5259204469957;1022.6471867205802;5066.645334826527;5079.4412614612365;5082.288479612857;5110.591152707774;5125.666831655931;7377.22539133394;7598.886016709754;7614.428917831185;7663.348615367756;7732.729354472566;7827.9608601956625;7863;7929.365650747926;7930.603469826601;7946.602669866484;5967.940320596826;6094;6100.359462256488;6188.907166392508;6211.16149319845;6202.34875338083;6241.251049874044;6249.125122482765;6256.749730010749;6276.560640755103;6927.272636373108;7044.330788575077;7069.71721131149;7080.433565314659;7147.714091436284;7111.075560177351;7212.531185472927;7251.8187045324285;7294.671739771829;7350.705971761284;5870.414987953314;5952.255968003999;5963.314218864886;5967;5970.432808883149;6164.815055548341;6189.566730328834;6278;6498.415142637185;6517.869642607026;5411.648242864201;5616.606837521498;5863.853403664943;6106.816795496142;6113.847153821012;5545.085060964896;5662.348829884616;5934.169216309807;5942.970285148546;6018.097285407224;6130.47890929276;6160.784372546939;6165.136880836776;6171.7531298749345;6203.16257305258;5454.10007348783;5462.235287059894;5462.91805622908;5480.890382192254;5524.475174858382;5594.552435805207;5614.831555053355;5619.578531610064;5637.182608521659;5669.801556945487 07:07:17 INFO - 2015-11-27 07:07:17,530 DEBUG : BROWSER_OUTPUT: |4;prototype.html;280.9789265805064;281.89288070533195;287.25743951884374;288.72715284056574;288.89455348797696;5271.630985830993;5280.6831590104575;5321.068812957731;5323.8136665216725;5398.568114550836;5265.552428043621;5270.341207349082;5271.630985830984;5276.868078298045;5300.416954135052;4146.502419709639;4149.149424367997;4150.979245103786;4151.543330233671;4160.043190066287;4145.523264824554;4146.730462519941;4153.605407486299;4155.62599366057;4156.958430415702;4115.464989551354;4116.135611521584;4124.113315637137;4127.050778320988;4130.173965206971;3918.235943990923;4041.7777022263763;4051.027753339207;4062.5328087270045;4064.532578753422;3489.040513858684;3500.7922266818164;3505.929881402383;3506.193575477629;3508.8771892983623;5079.923801142986;5085.262636917626;5090.440051594322;5094.6433749637545;5100.9489905100845;4656.604188643969;4659.138059458977;4664.766761661904;4667.066586682643;4671.392718946515;5459.290292262021;5591.077472217079;5607.383187849333;5610.607257491977;5615.101583746622;3771.2457508498137;3782.7352085354037;3786.2995345861104;3786.469894214812;3786.810659467043;5661.2923384576925;5791.305043394819;5828.358880523139;5907.2911250650195;5915.556333275022;3766.453864189677;3822.5412950446125;3843.2505661396317;3846.211526637033;3857.6528112470014;3913.9608603914166;3915.236528876899;3920.157166209279;3924.2543916655745;3930.194310166409;4349.652027837766;4464.910701785946;4522.796474158671;4561.24739417999;4659.20793465105;5605.971970140124;5611.410801865745;5617.185508101303;5621.156826476062;5625.803096891589;1391.7007843313736;1408.5070225421225;1410.132768347459;1412.3997301146971;1414.2080434956458;919.2829592917535;929.4934260827865;937.3906960475609;940.1209868772582;943.1558754914313;4906.55840974314;4907.484714105039;4912.484189160086;4920.015996800654;4932.358793356912;5819.272590926134;5821;5824.767009319665;5826.737796799154;5827.854303642443;4893.706377617284;4911.140550403665;4912.582430493377;4915.9508404916205;4922.655414120977;3062.3569050499646;3082.214035420953;3108.9378212436077;3111.782175247756;3155;5505.917411238835;5543.556515478833;5576.1356989666665;5581.358143813513;5591.776328946797;6074.42292982166;6076.574639775262;6084.361142080018;6085.421884920926;6090.147379366892;5514.283143191359;5563.13771365439;5573.191887176336;5574.554035677136;5580.162975553618;5657.377688454185;5834.18321435008;5841.4450627192045;5850.912236316543;5852.063669812809;5698.629589076697;5704.971475142598;5705;5706.657600543981;5709.771609135588;5517.172424136251;5523.8066667666435;5526.889462210653;5528.419515950767;5530.861728456821;3846.8653597123966;3852.614738526125;3891.9221615568094;3895.941560876646;3968.0873399117786;5639.689817060101;5781.479666829838;5815.331236907809;5816.592838501264;5820.592558520862;5528.861778455571;5632.493075623213;5639.8590035249445;5644.407337229696;5659.292588426447;5629.493345598916;5641.464060914206;5644;5645.633033852787;5653.462921022661;5392.784288628568;5523.061079616395;5526.143447765603;5538.280023597068;5538.778448862;5681.9147712783515;5685.147227915681;5687.260656114679;5687.8862422752145;5694.943050569607;5507.834764957058;5535.225068490495;5541.418151094238;5561.416051314715;5571.66570005801 07:07:17 INFO - 2015-11-27 07:07:17,531 DEBUG : BROWSER_OUTPUT: |5;yui.html;684.2336583027009;769.2000319667546;774.0981756253965;791.5844181804551;802.4823988527404;10260.589576416935;10436.478176091203;10440.164786817055;10451.059404653579;10464.947675261632;10198.388096714183;10246.282760206788;10280.897191028087;10290.588376464932;10302.278840481169;755.312665474417;772.193058254123;772.308783638643;772.5982489105662;772.7604442622777;757.75373003774;762.5196126440335;763.431243723424;764.1746913333615;764.2128607534221;805.7502174325948;808.3815880851154;811.1442428238206;811.2820154163549;812.3744716568239;801.0187520287631;802.6147449224405;804.947678400905;805.8630032894422;807.6083099696642;592.3750443282336;593.4243783530012;597.4503456819693;598.5032423088826;599.7271241585069;10601.681949541526;10710.250282480229;10727;10737.785244295148;10743.462826858626;10748.73128171794;10826.350418974887;11214.719632009264;11390.145739069603;11703.765924681544;8533.359998000175;8571.969659214396;8594.828103437896;9299.395539289924;9716.368436051634;3248.4640034394297;3258.3646188993157;3292.522584225298;3313.204830840581;3344.414727422691;34278.82860585681;34547.654523454694;34832.6516734832;37519.24961500809;40249;8822.955885220661;8944.150305720947;8990.325725570608;9010.50442225684;9019.909800902038;14640.414383424544;14641;14641.48754793577;14655.92672036633;14739.63150921214;5982.192404025488;6012.488938440281;6024.759009639565;6096.512279017668;6140.293866205444;3588.964110358915;3634.164142247298;3661.9450708239397;3708.721845861571;3719.888403347904;2556.974430255711;2558.6417901493805;2570.1390034338706;2570.408805974599;2578.3425226567106;463.677743967939;471.50727489772584;471.99700636148185;472.86286976777035;477.54394553202303;552.8396764938122;557.9442055794469;559.2282649943053;565.1522715926111;590.3624085987124;7202.459815513857;7203.639818009184;7294.744683936143;7350.264973502607;8280.296174825087;547.8520799384144;560.436761055137;576.2307319728126;583.0700033446645;588.2529187931389;3333.233356328058;3349.3468773588916;3461.3769521486374;3481.511596775309;3518.595361533405;48543.41750698644;49831;49922.500774991786;50130;50305.24542131798;41936.58063419327;41951.160976780906;44612.3308150378;44859.77570112129;45101;35694.46458303127;39872.00319992023;40261.19477610431;40822.59177408188;41756.58243417588;7389.187189409053;7510.849783004419;7780.766577002699;7882.132965373919;7966.84066318682;31907;32101.197470063435;32434.513482297312;32805;32858.67141328556;37238.8138059308;37612.62387376091;37909.43135853019;40007.79996100001;43044.78477607717;8820.338474614558;9511.57197926081;9744.12302892743;10082.445465499175;10185.439800811026;10539.578416863545;10674.786504270027;11063.50214240345;11069.446527673423;11123;9639.566219519998;9870.457124858201;9881.50592470388;9950.154236889946;9973.60105595768;9984.301098923006;10135.341202821794;10155.84766228522;10208.438535880598;10230.23273254494;10512.94743526308;10799.13606911461;10957.232993690684;10989.505472253928;11322.037626801484;9023.593938272925;9299.023602521638;9597.328187026842;9642.517874106126;9649.903500965182;8455.534945578052;8982.371234013557;9045.502497362708;9085.545722713705;9105.681301154427 07:07:17 INFO - 2015-11-27 07:07:17,531 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:07:17 INFO - 2015-11-27 07:07:17,531 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1082 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: __startTimestamp1448636837520__endTimestamp 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: Number of tests: 6 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4608.96 Median:4779.62 stddev:470.68 (9.8%) stddev-sans-first:445.26 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: Values: 2610.9 2698.0 2708.6 2714.4 2725.6 4436.4 4595.0 4614.4 4617.2 4656.7 4578.2 4581.3 4673.0 4676.1 4719.0 4292.9 4297.8 4305.4 4309.1 4324.6 4191.1 4378.3 4382.7 4427.0 4435.2 4190.1 4246.2 4288.7 4290.0 4314.4 4304.2 4350.5 4357.5 4378.2 4380.2 4137.8 4317.5 4319.2 4328.8 4365.0 4500.8 4542.4 4549.8 4585.5 4612.3 5010.4 5012.5 5023.7 5053.9 5056.2 4858.1 5023.7 5045.1 5051.1 5058.1 4517.5 4567.3 4574.5 4643.0 4655.0 5145.2 5170.7 5176.8 5179.1 5184.1 4953.4 4964.5 4969.6 5006.1 5007.1 4836.8 4876.1 4945.1 4949.1 4993.4 4907.3 4917.4 4922.3 4925.4 4972.4 4877.4 4878.4 4881.9 4895.2 4920.8 4113.5 4169.4 4207.8 4209.4 4210.8 3733.7 3762.6 3766.9 3767.0 3769.6 4223.6 4298.5 4306.6 4313.9 4322.7 5006.4 5019.7 5023.5 5025.7 5061.3 4298.8 4302.4 4303.2 4307.4 4349.6 4274.7 4373.7 4377.4 4413.8 4504.0 4810.5 4810.8 4820.8 4839.2 4857.3 4990.9 5079.0 5082.9 5083.9 5088.1 4573.5 4674.6 4675.7 4705.8 4840.4 4858.5 4875.5 4878.1 4893.4 4940.0 4928.6 4938.7 4955.2 4958.0 4961.6 4733.7 4776.9 4826.9 4834.9 4862.0 4879.6 4886.9 4894.0 4897.2 4926.1 4784.9 4810.1 4811.9 4846.6 4859.6 4694.2 4781.0 4794.5 4795.8 4905.9 4779.6 4788.4 4789.0 4825.2 4840.9 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:38084.78 Median:29128.34 stddev:59345.98 (203.7%) stddev-sans-first:59445.50 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: Values: 536.8 540.1 556.5 564.6 573.8 27981.3 28492.4 36061.5 36520.3 36535.6 39279.6 39430.4 39528.4 39554.8 39637.8 6924.7 7955.5 8100.6 8139.3 8147.1 7081.9 7143.1 7149.6 7150.5 7165.9 10230.7 10369.1 10374.4 10383.6 10396.1 10049.8 10136.5 10137.8 10139.5 10139.9 7229.1 7398.1 9964.1 10182.9 10439.6 35627.0 35974.0 35978.6 36010.0 36118.8 2557.8 2595.6 2694.2 2786.3 3081.6 27649.4 27763.6 27779.9 28118.6 28221.3 3429.8 3455.5 3461.7 3471.9 3573.3 219625.0 221271.0 221394.9 221989.0 223100.0 48424.0 49954.8 50005.5 52319.5 52884.5 60756.4 61847.0 61983.7 62414.7 62506.0 12337.9 12526.6 12527.4 12530.8 12539.4 8884.6 8891.0 8891.9 8901.6 8926.3 17294.9 17546.5 17658.2 17669.1 17700.2 7317.0 7608.2 7639.4 7653.4 7692.0 816.5 824.9 906.3 933.1 951.4 25835.4 26178.1 26374.3 26540.5 26573.3 948.0 957.6 961.3 1014.7 1035.1 12556.4 12604.2 12606.4 12741.5 13877.2 266177.0 270051.0 270205.0 270515.0 270781.0 44419.1 44478.3 44623.6 44692.8 44715.6 1189.7 1190.9 1193.2 1208.5 1212.3 25246.6 26163.7 26431.6 26744.6 26819.6 34530.5 35342.0 38763.4 39183.2 40546.0 182075.0 182675.0 184244.0 184521.0 184722.0 25460.2 25756.5 25817.0 25850.1 25874.6 27113.2 30205.5 35151.3 36325.3 36908.6 27919.2 28675.4 29117.1 29139.6 29153.6 28764.3 28976.9 30561.4 32333.8 32739.2 29429.0 29942.9 30155.8 30161.7 30167.7 26184.6 26301.9 26766.0 26782.9 27265.0 22130.3 23066.5 23632.5 24685.5 24963.4 07:07:17 INFO - 2015-11-27 07:07:17,532 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,533 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:26251.61 Median:23987.89 stddev:83349.13 (347.5%) stddev-sans-first:83560.18 07:07:17 INFO - 2015-11-27 07:07:17,534 DEBUG : BROWSER_OUTPUT: Values: 306.7 315.1 323.0 323.9 324.7 12392.1 12778.9 14781.0 15150.3 15291.1 13461.3 13571.3 13572.6 14197.9 14603.1 4270.8 4874.8 5016.0 5019.3 5857.4 3540.6 3642.7 5613.4 5736.6 5815.7 5687.4 5710.5 5713.3 5755.1 5765.1 5583.6 5744.7 5750.5 5758.1 5769.5 5014.5 5015.5 5028.5 5033.7 5037.3 18853.7 19018.0 19233.5 19398.7 19496.2 1790.2 1816.8 1848.3 1900.2 1945.4 12262.3 12620.5 12676.5 12702.6 12730.3 1734.6 1738.5 1741.0 1762.0 1861.7 50698.7 52743.0 52944.7 53132.0 53771.5 9089.9 9220.3 9249.9 9278.4 9294.1 11824.2 11852.6 11869.7 11882.8 11886.1 6550.8 6556.5 6609.6 6642.3 6652.7 6235.0 6257.5 6274.5 6318.2 6330.3 5601.4 5638.6 5648.4 5678.8 5688.9 1488.9 1545.1 1552.4 1632.4 1637.7 319.3 320.2 321.4 328.5 996.3 7664.3 8709.0 8724.1 8806.2 9212.9 323.5 335.7 336.8 351.0 362.4 4597.2 4628.3 4697.4 4697.5 4796.3 499800.0 505064.0 511921.0 515613.0 517359.0 70315.0 71286.0 72229.0 72783.6 73088.0 373.6 376.3 376.7 377.7 378.4 8617.4 8640.4 8818.7 8949.6 9091.8 30056.0 30178.8 31745.8 32042.2 32419.4 42292.0 43705.0 43765.8 43803.8 44962.6 7765.5 7914.2 7914.6 7937.4 8006.8 11892.6 15405.6 16022.9 16085.0 16089.5 13023.3 13182.3 13201.7 13433.0 13474.1 12828.3 13002.7 13082.3 13245.4 13407.7 10430.6 12235.9 13279.1 13569.9 13848.4 7462.1 7610.4 7617.8 7639.7 7653.9 8042.1 9354.5 12850.2 12989.8 13274.7 07:07:17 INFO - 2015-11-27 07:07:17,534 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,534 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4602.16 Median:5965.16 stddev:2375.98 (39.8%) stddev-sans-first:2369.35 07:07:17 INFO - 2015-11-27 07:07:17,534 DEBUG : BROWSER_OUTPUT: Values: 1257.4 1566.3 1616.0 1642.1 1646.5 5606.8 6501.6 6691.8 6707.4 6719.7 6564.1 6677.0 6702.3 6717.6 6730.0 1654.0 1680.7 1886.7 1892.0 1919.2 1901.2 1909.0 1909.6 1909.7 1910.9 1899.1 1925.2 1969.0 1969.2 1969.2 1895.1 1903.9 1930.4 1934.8 1939.9 1934.2 1952.5 1953.7 1954.7 1962.1 6571.9 6631.1 6637.7 6644.3 6659.3 3626.9 3664.0 3670.8 3673.3 3675.2 2204.3 2501.4 2522.8 2543.9 2572.1 750.3 830.1 859.3 888.3 903.2 8704.8 8787.9 8789.4 8796.1 8806.1 3480.1 3487.3 3543.4 3577.7 3581.1 7601.6 7616.8 7627.6 7634.4 7640.4 3748.7 3779.5 3782.2 3782.9 3782.9 3415.1 3425.9 3451.6 3452.4 3457.1 2775.2 2912.9 2913.1 3170.8 3172.1 863.2 944.7 996.1 998.1 1006.2 925.5 926.6 962.5 972.2 1181.6 6273.0 6341.8 6346.7 6348.0 6354.2 990.2 999.0 1010.7 1019.5 1022.6 5066.6 5079.4 5082.3 5110.6 5125.7 7377.2 7598.9 7614.4 7663.3 7732.7 7828.0 7863.0 7929.4 7930.6 7946.6 5967.9 6094.0 6100.4 6188.9 6211.2 6202.3 6241.3 6249.1 6256.7 6276.6 6927.3 7044.3 7069.7 7080.4 7147.7 7111.1 7212.5 7251.8 7294.7 7350.7 5870.4 5952.3 5963.3 5967.0 5970.4 6164.8 6189.6 6278.0 6498.4 6517.9 5411.6 5616.6 5863.9 6106.8 6113.8 5545.1 5662.3 5934.2 5943.0 6018.1 6130.5 6160.8 6165.1 6171.8 6203.2 5454.1 5462.2 5462.9 5480.9 5524.5 5594.6 5614.8 5619.6 5637.2 5669.8 07:07:17 INFO - 2015-11-27 07:07:17,534 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,534 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4629.13 Median:5290.55 stddev:1391.04 (26.3%) stddev-sans-first:1356.11 07:07:17 INFO - 2015-11-27 07:07:17,535 DEBUG : BROWSER_OUTPUT: Values: 281.0 281.9 287.3 288.7 288.9 5271.6 5280.7 5321.1 5323.8 5398.6 5265.6 5270.3 5271.6 5276.9 5300.4 4146.5 4149.1 4151.0 4151.5 4160.0 4145.5 4146.7 4153.6 4155.6 4157.0 4115.5 4116.1 4124.1 4127.1 4130.2 3918.2 4041.8 4051.0 4062.5 4064.5 3489.0 3500.8 3505.9 3506.2 3508.9 5079.9 5085.3 5090.4 5094.6 5100.9 4656.6 4659.1 4664.8 4667.1 4671.4 5459.3 5591.1 5607.4 5610.6 5615.1 3771.2 3782.7 3786.3 3786.5 3786.8 5661.3 5791.3 5828.4 5907.3 5915.6 3766.5 3822.5 3843.3 3846.2 3857.7 3914.0 3915.2 3920.2 3924.3 3930.2 4349.7 4464.9 4522.8 4561.2 4659.2 5606.0 5611.4 5617.2 5621.2 5625.8 1391.7 1408.5 1410.1 1412.4 1414.2 919.3 929.5 937.4 940.1 943.2 4906.6 4907.5 4912.5 4920.0 4932.4 5819.3 5821.0 5824.8 5826.7 5827.9 4893.7 4911.1 4912.6 4916.0 4922.7 3062.4 3082.2 3108.9 3111.8 3155.0 5505.9 5543.6 5576.1 5581.4 5591.8 6074.4 6076.6 6084.4 6085.4 6090.1 5514.3 5563.1 5573.2 5574.6 5580.2 5657.4 5834.2 5841.4 5850.9 5852.1 5698.6 5705.0 5705.0 5706.7 5709.8 5517.2 5523.8 5526.9 5528.4 5530.9 3846.9 3852.6 3891.9 3895.9 3968.1 5639.7 5781.5 5815.3 5816.6 5820.6 5528.9 5632.5 5639.9 5644.4 5659.3 5629.5 5641.5 5644.0 5645.6 5653.5 5392.8 5523.1 5526.1 5538.3 5538.8 5681.9 5685.1 5687.3 5687.9 5694.9 5507.8 5535.2 5541.4 5561.4 5571.7 07:07:17 INFO - 2015-11-27 07:07:17,535 DEBUG : BROWSER_OUTPUT: 07:07:17 INFO - 2015-11-27 07:07:17,535 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11840.52 Median:24510.48 stddev:13534.88 (55.2%) stddev-sans-first:13546.91 07:07:17 INFO - 2015-11-27 07:07:17,536 DEBUG : BROWSER_OUTPUT: Values: 684.2 769.2 774.1 791.6 802.5 10260.6 10436.5 10440.2 10451.1 10464.9 10198.4 10246.3 10280.9 10290.6 10302.3 755.3 772.2 772.3 772.6 772.8 757.8 762.5 763.4 764.2 764.2 805.8 808.4 811.1 811.3 812.4 801.0 802.6 804.9 805.9 807.6 592.4 593.4 597.5 598.5 599.7 10601.7 10710.3 10727.0 10737.8 10743.5 10748.7 10826.4 11214.7 11390.1 11703.8 8533.4 8572.0 8594.8 9299.4 9716.4 3248.5 3258.4 3292.5 3313.2 3344.4 34278.8 34547.7 34832.7 37519.2 40249.0 8823.0 8944.2 8990.3 9010.5 9019.9 14640.4 14641.0 14641.5 14655.9 14739.6 5982.2 6012.5 6024.8 6096.5 6140.3 3589.0 3634.2 3661.9 3708.7 3719.9 2557.0 2558.6 2570.1 2570.4 2578.3 463.7 471.5 472.0 472.9 477.5 552.8 557.9 559.2 565.2 590.4 7202.5 7203.6 7294.7 7350.3 8280.3 547.9 560.4 576.2 583.1 588.3 3333.2 3349.3 3461.4 3481.5 3518.6 48543.4 49831.0 49922.5 50130.0 50305.2 41936.6 41951.2 44612.3 44859.8 45101.0 35694.5 39872.0 40261.2 40822.6 41756.6 7389.2 7510.8 7780.8 7882.1 7966.8 31907.0 32101.2 32434.5 32805.0 32858.7 37238.8 37612.6 37909.4 40007.8 43044.8 8820.3 9511.6 9744.1 10082.4 10185.4 10539.6 10674.8 11063.5 11069.4 11123.0 9639.6 9870.5 9881.5 9950.2 9973.6 9984.3 10135.3 10155.8 10208.4 10230.2 10512.9 10799.1 10957.2 10989.5 11322.0 9023.6 9299.0 9597.3 9642.5 9649.9 8455.5 8982.4 9045.5 9085.5 9105.7 07:07:17 INFO - 2015-11-27 07:07:17,536 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:07:17 INFO - 2015-11-27 07:07:17,536 DEBUG : BROWSER_OUTPUT: 07:07:18 INFO - 2015-11-27 07:07:18,361 INFO : Browser exited with error code: 0 07:07:18 INFO - 2015-11-27 07:07:18,378 INFO : Completed test dromaeo_css (00:18:38) 07:07:18 INFO - 2015-11-27 07:07:18,378 INFO : Starting test kraken 07:07:18 INFO - 2015-11-27 07:07:18,378 DEBUG : operating with platform_type : linux_ 07:07:18 INFO - 2015-11-27 07:07:18,378 INFO : Initialising browser for kraken test... 07:07:18 INFO - 2015-11-27 07:07:18,384 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvF6wli/profile http://localhost:50666/getInfo.html 07:07:22 INFO - 2015-11-27 07:07:22,744 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:07:22 INFO - 2015-11-27 07:07:22,744 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:07:22 INFO - 2015-11-27 07:07:22,744 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 07:07:22 INFO - 2015-11-27 07:07:22,744 DEBUG : BROWSER_OUTPUT: __metrics 07:07:22 INFO - 2015-11-27 07:07:22,906 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:07:24 INFO - 2015-11-27 07:07:24,204 INFO : Browser initialized. 07:07:24 INFO - 2015-11-27 07:07:24,205 INFO : Running cycle 1/1 for kraken test... 07:07:24 INFO - 2015-11-27 07:07:24,205 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpvF6wli/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:07:36 INFO - 2015-11-27 07:07:36,170 DEBUG : BROWSER_OUTPUT: RSS: Main: 140890112 07:07:36 INFO - 2015-11-27 07:07:36,171 DEBUG : BROWSER_OUTPUT: 07:07:38 INFO - 2015-11-27 07:07:38,791 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:50666/tests/kraken/driver.html?testName=audio-beat-detection) 07:07:39 INFO - 2015-11-27 07:07:39,372 DEBUG : BROWSER_OUTPUT: RSS: Main: 177152000 07:07:39 INFO - 2015-11-27 07:07:39,372 DEBUG : BROWSER_OUTPUT: 07:07:42 INFO - 2015-11-27 07:07:42,136 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:50666/tests/kraken/driver.html?testName=audio-dft) 07:07:42 INFO - 2015-11-27 07:07:42,718 DEBUG : BROWSER_OUTPUT: RSS: Main: 166625280 07:07:42 INFO - 2015-11-27 07:07:42,718 DEBUG : BROWSER_OUTPUT: 07:07:45 INFO - 2015-11-27 07:07:45,717 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:50666/tests/kraken/driver.html?testName=audio-fft) 07:07:46 INFO - 2015-11-27 07:07:46,279 DEBUG : BROWSER_OUTPUT: RSS: Main: 152502272 07:07:46 INFO - 2015-11-27 07:07:46,279 DEBUG : BROWSER_OUTPUT: 07:07:48 INFO - 2015-11-27 07:07:48,291 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:50666/tests/kraken/driver.html?testName=audio-oscillator) 07:07:48 INFO - 2015-11-27 07:07:48,873 DEBUG : BROWSER_OUTPUT: RSS: Main: 154529792 07:07:48 INFO - 2015-11-27 07:07:48,874 DEBUG : BROWSER_OUTPUT: 07:07:51 INFO - 2015-11-27 07:07:51,128 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:50666/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:07:51 INFO - 2015-11-27 07:07:51,697 DEBUG : BROWSER_OUTPUT: RSS: Main: 156286976 07:07:51 INFO - 2015-11-27 07:07:51,698 DEBUG : BROWSER_OUTPUT: 07:07:54 INFO - 2015-11-27 07:07:54,699 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:50666/tests/kraken/driver.html?testName=imaging-darkroom) 07:07:55 INFO - 2015-11-27 07:07:55,283 DEBUG : BROWSER_OUTPUT: RSS: Main: 156315648 07:07:55 INFO - 2015-11-27 07:07:55,283 DEBUG : BROWSER_OUTPUT: 07:07:58 INFO - 2015-11-27 07:07:58,637 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:50666/tests/kraken/driver.html?testName=imaging-desaturate) 07:07:59 INFO - 2015-11-27 07:07:59,219 DEBUG : BROWSER_OUTPUT: RSS: Main: 156540928 07:07:59 INFO - 2015-11-27 07:07:59,219 DEBUG : BROWSER_OUTPUT: 07:08:02 INFO - 2015-11-27 07:08:02,022 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:50666/tests/kraken/driver.html?testName=json-parse-financial) 07:08:02 INFO - 2015-11-27 07:08:02,603 DEBUG : BROWSER_OUTPUT: RSS: Main: 156852224 07:08:02 INFO - 2015-11-27 07:08:02,603 DEBUG : BROWSER_OUTPUT: 07:08:04 INFO - 2015-11-27 07:08:04,372 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:50666/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:08:04 INFO - 2015-11-27 07:08:04,933 DEBUG : BROWSER_OUTPUT: RSS: Main: 165490688 07:08:04 INFO - 2015-11-27 07:08:04,933 DEBUG : BROWSER_OUTPUT: 07:08:06 INFO - 2015-11-27 07:08:06,836 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:08:07 INFO - 2015-11-27 07:08:07,429 DEBUG : BROWSER_OUTPUT: RSS: Main: 165367808 07:08:07 INFO - 2015-11-27 07:08:07,429 DEBUG : BROWSER_OUTPUT: 07:08:09 INFO - 2015-11-27 07:08:09,550 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:08:10 INFO - 2015-11-27 07:08:10,136 DEBUG : BROWSER_OUTPUT: RSS: Main: 176467968 07:08:10 INFO - 2015-11-27 07:08:10,136 DEBUG : BROWSER_OUTPUT: 07:08:12 INFO - 2015-11-27 07:08:12,671 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:08:13 INFO - 2015-11-27 07:08:13,265 DEBUG : BROWSER_OUTPUT: RSS: Main: 183042048 07:08:13 INFO - 2015-11-27 07:08:13,265 DEBUG : BROWSER_OUTPUT: 07:08:15 INFO - 2015-11-27 07:08:15,881 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:08:16 INFO - 2015-11-27 07:08:16,462 DEBUG : BROWSER_OUTPUT: RSS: Main: 179970048 07:08:16 INFO - 2015-11-27 07:08:16,462 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,212 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:50666/tests/kraken/driver.html?testName=ai-astar) 07:08:18 INFO - 2015-11-27 07:08:18,462 DEBUG : BROWSER_OUTPUT: RSS: Main: 239632384 07:08:18 INFO - 2015-11-27 07:08:18,462 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,462 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:08:18 INFO - 2015-11-27 07:08:18,462 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:08:18 INFO - 2015-11-27 07:08:18,462 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:08:18 INFO - 2015-11-27 07:08:18,462 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |0;ai-astar;110;112;108;114;114;112;104;112;113;106 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;159;130;158;175;137;169;155;130;166;130 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;161;162;162;161;160;161;162;162;162 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;72;84;91;73;75;73;113;90;73 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;94;95;131;93;95;96;134;94;94;128 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;110;109;109;109;110;110;110;109;113 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;148;146;146;146;147;146;147;147;148 07:08:18 INFO - 2015-11-27 07:08:18,463 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;95;95;95;96;95;95;96;95;96;95 07:08:18 INFO - 2015-11-27 07:08:18,464 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;72;82;72;71;75;71;72;73;71;70 07:08:18 INFO - 2015-11-27 07:08:18,464 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;71;71;72;71;71;71;70;70;70;71 07:08:18 INFO - 2015-11-27 07:08:18,464 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;83;85;92;83;83;84;84;84;84;86 07:08:18 INFO - 2015-11-27 07:08:18,464 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;125;126;128;122;124;125;127;120;125;122 07:08:18 INFO - 2015-11-27 07:08:18,464 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;150;140;147;146;147;153;149;146;149;141 07:08:18 INFO - 2015-11-27 07:08:18,464 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;69;69;68;68;68;69;68;69;68;69 07:08:18 INFO - 2015-11-27 07:08:18,464 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:08:18 INFO - 2015-11-27 07:08:18,465 DEBUG : BROWSER_OUTPUT: __start_cc_report 07:08:18 INFO - 2015-11-27 07:08:18,465 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,1004 07:08:18 INFO - 2015-11-27 07:08:18,465 DEBUG : BROWSER_OUTPUT: __end_cc_report 07:08:18 INFO - 2015-11-27 07:08:18,465 DEBUG : BROWSER_OUTPUT: __startTimestamp1448636898461__endTimestamp 07:08:18 INFO - 2015-11-27 07:08:18,465 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,468 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:08:18 INFO - 2015-11-27 07:08:18,468 DEBUG : BROWSER_OUTPUT: Number of tests: 14 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.50 Median:112.00 stddev:3.44 (3.1%) stddev-sans-first:3.64 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: Values: 110.0 112.0 108.0 114.0 114.0 112.0 104.0 112.0 113.0 106.0 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:150.90 Median:158.50 stddev:17.55 (11.1%) stddev-sans-first:18.37 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: Values: 159.0 130.0 158.0 175.0 137.0 169.0 155.0 130.0 166.0 130.0 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.40 Median:162.00 stddev:0.70 (0.4%) stddev-sans-first:0.73 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: Values: 161.0 161.0 162.0 162.0 161.0 160.0 161.0 162.0 162.0 162.0 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:81.60 Median:74.00 stddev:13.33 (18.0%) stddev-sans-first:13.68 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: Values: 72.0 72.0 84.0 91.0 73.0 75.0 73.0 113.0 90.0 73.0 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.40 Median:94.00 stddev:17.74 (18.9%) stddev-sans-first:18.33 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: Values: 94.0 95.0 131.0 93.0 95.0 96.0 134.0 94.0 94.0 128.0 07:08:18 INFO - 2015-11-27 07:08:18,469 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.80 Median:110.00 stddev:1.23 (1.1%) stddev-sans-first:1.27 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: Values: 109.0 110.0 109.0 109.0 109.0 110.0 110.0 110.0 109.0 113.0 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:146.70 Median:147.00 stddev:0.82 (0.6%) stddev-sans-first:0.83 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: Values: 146.0 148.0 146.0 146.0 146.0 147.0 146.0 147.0 147.0 148.0 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 95.0 96.0 95.0 95.0 96.0 95.0 96.0 95.0 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:72.90 Median:72.00 stddev:3.48 (4.8%) stddev-sans-first:3.67 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: Values: 72.0 82.0 72.0 71.0 75.0 71.0 72.0 73.0 71.0 70.0 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:70.80 Median:71.00 stddev:0.63 (0.9%) stddev-sans-first:0.67 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: Values: 71.0 71.0 72.0 71.0 71.0 71.0 70.0 70.0 70.0 71.0 07:08:18 INFO - 2015-11-27 07:08:18,470 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:84.80 Median:84.00 stddev:2.70 (3.2%) stddev-sans-first:2.78 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: Values: 83.0 85.0 92.0 83.0 83.0 84.0 84.0 84.0 84.0 86.0 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:124.40 Median:125.00 stddev:2.46 (2.0%) stddev-sans-first:2.60 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: Values: 125.0 126.0 128.0 122.0 124.0 125.0 127.0 120.0 125.0 122.0 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:146.80 Median:148.00 stddev:3.94 (2.7%) stddev-sans-first:4.00 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: Values: 150.0 140.0 147.0 146.0 147.0 153.0 149.0 146.0 149.0 141.0 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: 07:08:18 INFO - 2015-11-27 07:08:18,471 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.50 Median:69.00 stddev:0.53 (0.8%) stddev-sans-first:0.53 07:08:18 INFO - 2015-11-27 07:08:18,472 DEBUG : BROWSER_OUTPUT: Values: 69.0 69.0 68.0 68.0 68.0 69.0 68.0 69.0 68.0 69.0 07:08:18 INFO - 2015-11-27 07:08:18,472 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:08:18 INFO - 2015-11-27 07:08:18,472 DEBUG : BROWSER_OUTPUT: 07:08:19 INFO - 2015-11-27 07:08:19,417 INFO : Browser exited with error code: 0 07:08:19 INFO - 2015-11-27 07:08:19,468 INFO : Completed test kraken (00:01:01) 07:08:19 INFO - 2015-11-27 07:08:19,468 INFO : Starting test v8_7 07:08:19 INFO - 2015-11-27 07:08:19,468 DEBUG : operating with platform_type : linux_ 07:08:19 INFO - 2015-11-27 07:08:19,468 INFO : Initialising browser for v8_7 test... 07:08:19 INFO - 2015-11-27 07:08:19,474 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLEp1D4/profile http://localhost:50666/getInfo.html 07:08:23 INFO - 2015-11-27 07:08:23,735 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 07:08:23 INFO - 2015-11-27 07:08:23,735 DEBUG : BROWSER_OUTPUT: colorDepth:24 07:08:23 INFO - 2015-11-27 07:08:23,735 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 07:08:23 INFO - 2015-11-27 07:08:23,735 DEBUG : BROWSER_OUTPUT: __metrics 07:08:23 INFO - 2015-11-27 07:08:23,856 DEBUG : BROWSER_OUTPUT: JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 07:08:25 INFO - 2015-11-27 07:08:25,195 INFO : Browser initialized. 07:08:25 INFO - 2015-11-27 07:08:25,195 INFO : Running cycle 1/1 for v8_7 test... 07:08:25 INFO - 2015-11-27 07:08:25,195 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLEp1D4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 07:08:37 INFO - 2015-11-27 07:08:37,109 DEBUG : BROWSER_OUTPUT: RSS: Main: 138981376 07:08:37 INFO - 2015-11-27 07:08:37,109 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,560 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:50666/tests/v8_7/run.html (next: http://localhost:50666/tests/v8_7/run.html) 07:08:58 INFO - 2015-11-27 07:08:58,811 DEBUG : BROWSER_OUTPUT: RSS: Main: 487067648 07:08:58 INFO - 2015-11-27 07:08:58,811 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,811 DEBUG : BROWSER_OUTPUT: __start_tp_report 07:08:58 INFO - 2015-11-27 07:08:58,811 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 07:08:58 INFO - 2015-11-27 07:08:58,811 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 07:08:58 INFO - 2015-11-27 07:08:58,812 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 07:08:58 INFO - 2015-11-27 07:08:58,812 DEBUG : BROWSER_OUTPUT: |0;Richards;165.92002654720426 07:08:58 INFO - 2015-11-27 07:08:58,812 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;191.79133103183736 07:08:58 INFO - 2015-11-27 07:08:58,812 DEBUG : BROWSER_OUTPUT: |2;Encrypt;279.4857462269424 07:08:58 INFO - 2015-11-27 07:08:58,812 DEBUG : BROWSER_OUTPUT: |3;Decrypt;5202.072538860104 07:08:58 INFO - 2015-11-27 07:08:58,812 DEBUG : BROWSER_OUTPUT: |4;RayTrace;2057.61316872428 07:08:58 INFO - 2015-11-27 07:08:58,812 DEBUG : BROWSER_OUTPUT: |5;Earley;798.2456140350877 07:08:58 INFO - 2015-11-27 07:08:58,813 DEBUG : BROWSER_OUTPUT: |6;Boyer;12370.37037037037 07:08:58 INFO - 2015-11-27 07:08:58,813 DEBUG : BROWSER_OUTPUT: |7;RegExp;27000 07:08:58 INFO - 2015-11-27 07:08:58,813 DEBUG : BROWSER_OUTPUT: |8;Splay;701.7543859649123 07:08:58 INFO - 2015-11-27 07:08:58,813 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4835.748792270531 07:08:58 INFO - 2015-11-27 07:08:58,813 DEBUG : BROWSER_OUTPUT: __end_tp_report 07:08:58 INFO - 2015-11-27 07:08:58,814 DEBUG : BROWSER_OUTPUT: __startTimestamp1448636938810__endTimestamp 07:08:58 INFO - 2015-11-27 07:08:58,814 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,814 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 07:08:58 INFO - 2015-11-27 07:08:58,814 DEBUG : BROWSER_OUTPUT: Number of tests: 10 07:08:58 INFO - 2015-11-27 07:08:58,814 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,814 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:165.92 Median:165.92 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,815 DEBUG : BROWSER_OUTPUT: Values: 165.9 07:08:58 INFO - 2015-11-27 07:08:58,815 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,815 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:191.79 Median:191.79 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,816 DEBUG : BROWSER_OUTPUT: Values: 191.8 07:08:58 INFO - 2015-11-27 07:08:58,816 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,816 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:279.49 Median:279.49 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,817 DEBUG : BROWSER_OUTPUT: Values: 279.5 07:08:58 INFO - 2015-11-27 07:08:58,817 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,817 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:5202.07 Median:5202.07 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,817 DEBUG : BROWSER_OUTPUT: Values: 5202.1 07:08:58 INFO - 2015-11-27 07:08:58,817 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,817 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:2057.61 Median:2057.61 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,817 DEBUG : BROWSER_OUTPUT: Values: 2057.6 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:798.25 Median:798.25 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: Values: 798.2 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12370.37 Median:12370.37 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: Values: 12370.4 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,818 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:27000.00 Median:27000.00 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: Values: 27000.0 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:701.75 Median:701.75 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: Values: 701.8 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4835.75 Median:4835.75 stddev:0.00 (0.0%) 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: Values: 4835.7 07:08:58 INFO - 2015-11-27 07:08:58,819 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 07:08:58 INFO - 2015-11-27 07:08:58,820 DEBUG : BROWSER_OUTPUT: 07:08:59 INFO - 2015-11-27 07:08:59,690 INFO : Browser exited with error code: 0 07:08:59 INFO - 2015-11-27 07:08:59,708 INFO : Completed test v8_7 (00:00:40) 07:08:59 INFO - 2015-11-27 07:08:59,793 INFO : Completed test suite (00:20:19) 07:08:59 INFO - 2015-11-27 07:08:59,793 DEBUG : Working with test: dromaeo_css 07:08:59 INFO - 2015-11-27 07:08:59,794 DEBUG : Generating results file: dromaeo_css 07:08:59 INFO - 2015-11-27 07:08:59,795 DEBUG : Working with test: kraken 07:08:59 INFO - 2015-11-27 07:08:59,795 DEBUG : Generating results file: kraken 07:08:59 INFO - 2015-11-27 07:08:59,795 INFO : javascript benchmark 07:08:59 INFO - 2015-11-27 07:08:59,796 DEBUG : Working with test: v8_7 07:08:59 INFO - 2015-11-27 07:08:59,796 DEBUG : Generating results file: v8_7 07:08:59 INFO - 2015-11-27 07:08:59,796 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:08:59 INFO - 2015-11-27 07:08:59,850 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,35]] 07:08:59 INFO - 2015-11-27 07:08:59,850 DEBUG : process_Request line: dromaeo_css 6017.85 graph.html#tests=[[72,132,35]] 07:08:59 INFO - 2015-11-27 07:08:59,850 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:08:59 INFO - 2015-11-27 07:08:59,879 DEBUG : process_Request line: kraken 1529.80 graph.html#tests=[[232,132,35]] 07:08:59 INFO - 2015-11-27 07:08:59,879 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 07:08:59 INFO - 2015-11-27 07:08:59,914 DEBUG : process_Request line: v8_7 19317.07 graph.html#tests=[[230,132,35]] 07:08:59 INFO - 2015-11-27 07:08:59,916 INFO : javascript benchmark 07:08:59 INFO - 2015-11-27 07:08:59,919 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2610.9216723498294, 2698.0287096645206, 2708.566629339306, 2714.3756935904753, 2725.618413422121, 4436.401085853408, 4594.977025114878, 4614.377059097021, 4617.168909596276, 4656.743879086653, 4578.221702310607, 4581.289900065487, 4672.976635116828, 4676.064787042596, 4718.952810471894, 4292.871213863589, 4297.763623000734, 4305.3541968704785, 4309.052008558112, 4324.589164029412, 4191.11986482839, 4378.255696531582, 4382.715123516977, 4427.026054268072, 4435.179491794029, 4190.078182799779, 4246.171996460692, 4288.742675439484, 4290.0, 4314.352847072964, 4304.246756817575, 4350.456192975878, 4357.455318085239, 4378.190034843564, 4380.2115619188535, 4137.751734895915, 4317.525072242051, 4319.157764235975, 4328.761918094504, 4364.956350436487, 4500.842470513549, 4542.432195975503, 4549.840755573539, 4585.518520555361, 4612.331211974279, 5010.3737032870895, 5012.473690262506, 5023.7236951967625, 5053.9241911371355, 5056.191009438472, 4858.101251268491, 5023.748812559394, 5045.117104506697, 5051.1413059779925, 5058.0895438821, 4517.503074661785, 4567.269236922077, 4574.4968053514085, 4643.024964757371, 4655.0, 5145.15105007677, 5170.741462926839, 5176.844694659167, 5179.1454410021925, 5184.092783762826, 4953.430355509163, 4964.528369804862, 4969.602431805447, 5006.148954677641, 5007.12375334315, 4836.782344794493, 4876.073546026315, 4945.134601444733, 4949.084419382426, 4993.425756038029, 4907.263910413467, 4917.385326834145, 4922.335484709519, 4925.359703238556, 4972.378452693413, 4877.365942427462, 4878.390201224847, 4881.8535443936735, 4895.241237608177, 4920.778564964585, 4113.526944401372, 4169.353750168729, 4207.76857272853, 4209.431726716854, 4210.789460526961, 3733.738638295293, 3762.6237376262156, 3766.8681596144, 3767.03940495172, 3769.5853456119803, 4223.640990515779, 4298.4841818981295, 4306.612404883575, 4313.870583882489, 4322.654187664979, 5006.4492905780335, 5019.67372120811, 5023.547880690682, 5025.692192566725, 5061.291419201315, 4298.806553705091, 4302.440682711227, 4303.225419424471, 4307.440032795716, 4349.608535231844, 4274.7435153890865, 4373.693841431069, 4377.387165796791, 4413.757243351646, 4504.009117994036, 4810.542998415145, 4810.783514741775, 4820.807167713322, 4839.225723884232, 4857.295692124551, 4990.850274491771, 5078.97460512695, 5082.898342033212, 5083.923741143812, 5088.0587091388215, 4573.542645735533, 4674.649401294984, 4675.696079754805, 4705.811767529397, 4840.394950631171, 4858.514148585114, 4875.463698993179, 4878.07316609843, 4893.363862697826, 4940.0, 4928.6057115431395, 4938.654294199371, 4955.20716685343, 4957.950420495749, 4961.578265847444, 4733.7396443194575, 4776.928346074881, 4826.855194344175, 4834.903301933871, 4861.951380486292, 4879.56083952446, 4886.949623165438, 4894.045661096052, 4897.167481528078, 4926.088673595253, 4784.856454306377, 4810.086083644096, 4811.879703007453, 4846.5638092571835, 4859.562639362474, 4694.155052090657, 4780.95219047805, 4794.520547945317, 4795.760211989456, 4905.877353066202, 4779.617630589475, 4788.449328327287, 4789.0, 4825.155597770447, 4840.927386089282], "unit": "ms", "name": "dojo.html", "value": 4580.314794572582}, {"lowerIsBetter": false, "replicates": [536.7745546870314, 540.0818608365777, 556.4657928388747, 564.5540023381528, 573.8421933968158, 27981.300467488323, 28492.430151396984, 36061.45907811385, 36520.26959460809, 36535.63464365355, 39279.60720392795, 39430.43702159358, 39528.40707389391, 39554.802225988904, 39637.8018109909, 6924.688389022506, 7955.482893611911, 8100.635471403772, 8139.267465928066, 8147.063087744897, 7081.89377159343, 7143.071400717926, 7149.606771627558, 7150.463715221354, 7165.89251161233, 10230.744231394237, 10369.118624916853, 10374.429406382646, 10383.636572719955, 10396.116330111912, 10049.799004019915, 10136.493175341277, 10137.797244055151, 10139.493025348704, 10139.949300253526, 7229.132504099489, 7398.149212840538, 9964.05341492557, 10182.898171018269, 10439.634612788515, 35626.971707404904, 35974.0, 35978.64021359779, 36010.0, 36118.819405903065, 2557.8429223380253, 2595.6236345729762, 2694.191742477249, 2786.3312804926672, 3081.6302043754895, 27649.447011059867, 27763.583546246824, 27779.86110069437, 28118.578221326698, 28221.29446763827, 3429.8285085745615, 3455.481677748333, 3461.671141241578, 3471.89584312471, 3573.3210689969083, 219625.0, 221271.0, 221394.89302553545, 221989.0, 223100.0, 48424.0, 49954.75022624864, 50005.49994500081, 52319.476805232225, 52884.471155288724, 60756.392436075075, 61847.0, 61983.690081549306, 62414.68792656008, 62506.0, 12337.938310308571, 12526.561570344995, 12527.436265367898, 12530.812037819258, 12539.37303134858, 8884.600192991331, 8890.955545222232, 8891.911080889238, 8901.554922253861, 8926.285897128215, 17294.913525432545, 17546.473605791845, 17658.205380757896, 17669.11654417274, 17700.20349084294, 7317.0366301281565, 7608.2391760824585, 7639.388848892076, 7653.425993050543, 7691.961540192263, 816.4652152839899, 824.9175082491823, 906.3112034853427, 933.1461712533091, 951.3911096897991, 25835.354116147246, 26178.08376706806, 26374.340641484116, 26540.46919061608, 26573.33566660849, 947.9526023698787, 957.5547370472624, 961.3030552849268, 1014.7057353367588, 1035.1201478743158, 12556.434960426803, 12604.180728252633, 12606.369681516071, 12741.49034038628, 13877.167369957835, 266177.0, 270051.0, 270205.0, 270515.0, 270781.0, 44419.11161776746, 44478.33282500765, 44623.55376446194, 44692.77653611711, 44715.55284447114, 1189.714468527547, 1190.863050749175, 1193.1588230297618, 1208.4622343057256, 1212.2847519963263, 25246.621300680872, 26163.73836261613, 26431.60352594751, 26744.59883101794, 26819.597706034034, 34530.482042768876, 35342.0, 38763.41854872236, 39183.2163356737, 40546.0, 182075.0, 182675.0, 184244.0, 184521.0, 184722.0, 25460.236192914243, 25756.484870302113, 25817.0, 25850.095246666275, 25874.61188082218, 27113.1866044019, 30205.546916796706, 35151.296974059864, 36325.273494529436, 36908.630913691595, 27919.162425127277, 28675.426491470473, 29117.12648620545, 29139.562906556843, 29153.562696559144, 28764.280892977007, 28976.855115724287, 30561.388772223985, 32333.838330808194, 32739.181520462178, 29429.0, 29942.850285749304, 30155.849220754633, 30161.69838301589, 30167.69832301737, 26184.607230891932, 26301.868490657424, 26766.0, 26782.866085669448, 27265.0, 22130.336089917328, 23066.53866922686, 23632.52734945257, 24685.50628987446, 24963.375915602257], "unit": "ms", "name": "ext.html", "value": 16284.909828275648}, {"lowerIsBetter": false, "replicates": [306.68258352605056, 315.0516943998564, 322.95478632991376, 323.88178314915064, 324.7191179629621, 12392.07059470541, 12778.872211277885, 14781.0, 15150.318235679393, 15291.082535047892, 13461.259630720306, 13571.253581053039, 13572.592822215349, 14197.92901035496, 14603.123812571253, 4270.786460676969, 4874.805007799692, 5015.974920125394, 5019.322391477159, 5857.4435428634215, 3540.5574303212097, 3642.672159505644, 5613.410591887854, 5736.569757268201, 5815.738291776859, 5687.374388817227, 5710.457506536894, 5713.285839270091, 5755.136729490568, 5765.1352297155345, 5583.58123140764, 5744.712764361765, 5750.482456578907, 5758.078707406816, 5769.509591684712, 5014.52362025607, 5015.523525265094, 5028.547430731252, 5033.672811267256, 5037.345145131146, 18853.717194242097, 19018.0, 19233.519162020923, 19398.70901936472, 19496.220151193935, 1790.185465613143, 1816.8455681267108, 1848.334599544163, 1900.1924182222638, 1945.367755479475, 12262.26426414418, 12620.495180192782, 12676.492940282378, 12702.555410560586, 12730.299833509152, 1734.6010417604023, 1738.4697667211497, 1740.9651806963916, 1761.9647607047787, 1861.655593715167, 50698.7465062676, 52743.0, 52944.73527632337, 53132.0, 53771.46228537743, 9089.909100909039, 9220.308476864262, 9249.861252081224, 9278.396904201205, 9294.070592940787, 11824.23142495735, 11852.585159519376, 11869.703257418461, 11882.821757673642, 11886.108541859396, 6550.7707230246715, 6556.524781924124, 6609.603423794588, 6642.269350371455, 6652.70062847173, 6234.9688251558455, 6257.468115210167, 6274.498040156868, 6318.241810982619, 6330.335314791972, 5601.411851755588, 5638.633488823213, 5648.378678345379, 5678.801241956594, 5688.8862222755315, 1488.880889528835, 1545.0652355325092, 1552.4023251048202, 1632.3796957156442, 1637.683690526693, 319.2784307465099, 320.2074864709825, 321.44229761364016, 328.505599073393, 996.3374356053289, 7664.31021208094, 8708.953395951947, 8724.127587241352, 8806.163414475615, 9212.861807072899, 323.54864963375957, 335.69749372435285, 336.83831760754975, 350.9964900351015, 362.351391010089, 4597.241455159928, 4628.305754136906, 4697.436307643105, 4697.4832768395445, 4796.2805579163405, 499800.0, 505064.0, 511921.0, 515613.0, 517358.95846249344, 70315.0, 71286.0, 72229.0, 72783.63608182031, 73088.0, 373.60584583264915, 376.30008184776295, 376.7118154611724, 377.7487970499642, 378.3737913752744, 8617.396782225183, 8640.395172337876, 8818.691345803123, 8949.59726812282, 9091.772705682146, 30056.0, 30178.849105754332, 31745.8412707935, 32042.19894502563, 32419.35161296808, 42292.0, 43705.0, 43765.78117109394, 43803.78098109489, 44962.55037449583, 7765.534067955715, 7914.2085791420395, 7914.643841027052, 7937.444378893653, 8006.759797206093, 11892.643220703392, 15405.614859628598, 16022.919885400499, 16085.0, 16089.517314480585, 13023.283719395524, 13182.340882956005, 13201.735965280448, 13432.992525560427, 13474.124181928144, 12828.29444380568, 13002.739945201232, 13082.28047457399, 13245.403956821774, 13407.731845362843, 10430.634927777492, 12235.93882030584, 13279.070465067352, 13569.86430135686, 13848.376823042785, 7462.141853686896, 7610.391168706379, 7617.809554761176, 7639.694412223449, 7653.88519172224, 8042.075161356519, 9354.485503297385, 12850.164739291917, 12989.805152922903, 13274.668133296746], "unit": "ms", "name": "jquery.html", "value": 7265.848580520092}, {"lowerIsBetter": false, "replicates": [1257.377598088945, 1566.2638559876857, 1616.0465325457985, 1642.0804349564253, 1646.5060481855444, 5606.83179504615, 6501.609903405793, 6691.765788197414, 6707.362800533953, 6719.7312107515645, 6564.08102865598, 6677.031830384592, 6702.296258892807, 6717.563358381702, 6730.0, 1653.9503814885572, 1680.731083026716, 1886.735856980024, 1892.0, 1919.193938545814, 1901.2300018492533, 1909.0168563189968, 1909.551255454974, 1909.6849019911767, 1910.866239363245, 1899.0884375499768, 1925.1817977359635, 1969.035172765342, 1969.1729473621112, 1969.2221572478861, 1895.071415006637, 1903.9333623323187, 1930.3919265431343, 1934.8065193480609, 1939.8739081959698, 1934.1876411906892, 1952.4825921130912, 1953.677643188872, 1954.6677064899002, 1962.1268535501708, 6571.868562628769, 6631.1379520662, 6637.73449062037, 6644.302348253412, 6659.33406659335, 3626.8549258029648, 3664.0, 3670.779753214789, 3673.265346930598, 3675.1547144156993, 2204.3166618348364, 2501.399664080626, 2522.810789190818, 2543.949121017588, 2572.0740533407957, 750.3134631811886, 830.0537387378394, 859.2567429173782, 888.2893685051997, 903.1555495611558, 8704.825903481958, 8787.868181977276, 8789.384743067987, 8796.076411976714, 8806.075362087016, 3480.129967508123, 3487.2851065531504, 3543.4153364695053, 3577.6601222884306, 3581.068922080278, 7601.619919004138, 7616.809579760439, 7627.580483073373, 7634.427417943676, 7640.3505702015955, 3748.700103991674, 3779.4897688811657, 3782.224643947984, 3782.867599634, 3782.905427364338, 3415.077928959167, 3425.8629654813526, 3451.6375780543185, 3452.4130897747445, 3457.066592020191, 2775.153578158681, 2912.8689208985224, 2913.140623516068, 3170.8414579271407, 3172.1118086935694, 863.1972265792873, 944.6552008516979, 996.0885789502669, 998.0917365197636, 1006.2201793610011, 925.509479975614, 926.643242351686, 962.451402700454, 972.2076507646245, 1181.5628217559558, 6272.968635156795, 6341.8097457076365, 6346.650934198663, 6347.96826015867, 6354.17395738551, 990.1732053735068, 998.960041598328, 1010.7068950004416, 1019.5259204469957, 1022.6471867205802, 5066.645334826527, 5079.4412614612365, 5082.288479612857, 5110.591152707774, 5125.666831655931, 7377.22539133394, 7598.886016709754, 7614.428917831185, 7663.348615367756, 7732.729354472566, 7827.9608601956625, 7863.0, 7929.365650747926, 7930.603469826601, 7946.602669866484, 5967.940320596826, 6094.0, 6100.359462256488, 6188.907166392508, 6211.16149319845, 6202.34875338083, 6241.251049874044, 6249.125122482765, 6256.749730010749, 6276.560640755103, 6927.272636373108, 7044.330788575077, 7069.71721131149, 7080.433565314659, 7147.714091436284, 7111.075560177351, 7212.531185472927, 7251.8187045324285, 7294.671739771829, 7350.705971761284, 5870.414987953314, 5952.255968003999, 5963.314218864886, 5967.0, 5970.432808883149, 6164.815055548341, 6189.566730328834, 6278.0, 6498.415142637185, 6517.869642607026, 5411.648242864201, 5616.606837521498, 5863.853403664943, 6106.816795496142, 6113.847153821012, 5545.085060964896, 5662.348829884616, 5934.169216309807, 5942.970285148546, 6018.097285407224, 6130.47890929276, 6160.784372546939, 6165.136880836776, 6171.7531298749345, 6203.16257305258, 5454.10007348783, 5462.235287059894, 5462.91805622908, 5480.890382192254, 5524.475174858382, 5594.552435805207, 5614.831555053355, 5619.578531610064, 5637.182608521659, 5669.801556945487], "unit": "ms", "name": "mootools.html", "value": 3791.724603504053}, {"lowerIsBetter": false, "replicates": [280.9789265805064, 281.89288070533195, 287.25743951884374, 288.72715284056574, 288.89455348797696, 5271.630985830993, 5280.6831590104575, 5321.068812957731, 5323.8136665216725, 5398.568114550836, 5265.552428043621, 5270.341207349082, 5271.630985830984, 5276.868078298045, 5300.416954135052, 4146.502419709639, 4149.149424367997, 4150.979245103786, 4151.543330233671, 4160.043190066287, 4145.523264824554, 4146.730462519941, 4153.605407486299, 4155.62599366057, 4156.958430415702, 4115.464989551354, 4116.135611521584, 4124.113315637137, 4127.050778320988, 4130.173965206971, 3918.235943990923, 4041.7777022263763, 4051.027753339207, 4062.5328087270045, 4064.532578753422, 3489.040513858684, 3500.7922266818164, 3505.929881402383, 3506.193575477629, 3508.8771892983623, 5079.923801142986, 5085.262636917626, 5090.440051594322, 5094.6433749637545, 5100.9489905100845, 4656.604188643969, 4659.138059458977, 4664.766761661904, 4667.066586682643, 4671.392718946515, 5459.290292262021, 5591.077472217079, 5607.383187849333, 5610.607257491977, 5615.101583746622, 3771.2457508498137, 3782.7352085354037, 3786.2995345861104, 3786.469894214812, 3786.810659467043, 5661.2923384576925, 5791.305043394819, 5828.358880523139, 5907.2911250650195, 5915.556333275022, 3766.453864189677, 3822.5412950446125, 3843.2505661396317, 3846.211526637033, 3857.6528112470014, 3913.9608603914166, 3915.236528876899, 3920.157166209279, 3924.2543916655745, 3930.194310166409, 4349.652027837766, 4464.910701785946, 4522.796474158671, 4561.24739417999, 4659.20793465105, 5605.971970140124, 5611.410801865745, 5617.185508101303, 5621.156826476062, 5625.803096891589, 1391.7007843313736, 1408.5070225421225, 1410.132768347459, 1412.3997301146971, 1414.2080434956458, 919.2829592917535, 929.4934260827865, 937.3906960475609, 940.1209868772582, 943.1558754914313, 4906.55840974314, 4907.484714105039, 4912.484189160086, 4920.015996800654, 4932.358793356912, 5819.272590926134, 5821.0, 5824.767009319665, 5826.737796799154, 5827.854303642443, 4893.706377617284, 4911.140550403665, 4912.582430493377, 4915.9508404916205, 4922.655414120977, 3062.3569050499646, 3082.214035420953, 3108.9378212436077, 3111.782175247756, 3155.0, 5505.917411238835, 5543.556515478833, 5576.1356989666665, 5581.358143813513, 5591.776328946797, 6074.42292982166, 6076.574639775262, 6084.361142080018, 6085.421884920926, 6090.147379366892, 5514.283143191359, 5563.13771365439, 5573.191887176336, 5574.554035677136, 5580.162975553618, 5657.377688454185, 5834.18321435008, 5841.4450627192045, 5850.912236316543, 5852.063669812809, 5698.629589076697, 5704.971475142598, 5705.0, 5706.657600543981, 5709.771609135588, 5517.172424136251, 5523.8066667666435, 5526.889462210653, 5528.419515950767, 5530.861728456821, 3846.8653597123966, 3852.614738526125, 3891.9221615568094, 3895.941560876646, 3968.0873399117786, 5639.689817060101, 5781.479666829838, 5815.331236907809, 5816.592838501264, 5820.592558520862, 5528.861778455571, 5632.493075623213, 5639.8590035249445, 5644.407337229696, 5659.292588426447, 5629.493345598916, 5641.464060914206, 5644.0, 5645.633033852787, 5653.462921022661, 5392.784288628568, 5523.061079616395, 5526.143447765603, 5538.280023597068, 5538.778448862, 5681.9147712783515, 5685.147227915681, 5687.260656114679, 5687.8862422752145, 5694.943050569607, 5507.834764957058, 5535.225068490495, 5541.418151094238, 5561.416051314715, 5571.66570005801], "unit": "ms", "name": "prototype.html", "value": 4173.729275490467}, {"lowerIsBetter": false, "replicates": [684.2336583027009, 769.2000319667546, 774.0981756253965, 791.5844181804551, 802.4823988527404, 10260.589576416935, 10436.478176091203, 10440.164786817055, 10451.059404653579, 10464.947675261632, 10198.388096714183, 10246.282760206788, 10280.897191028087, 10290.588376464932, 10302.278840481169, 755.312665474417, 772.193058254123, 772.308783638643, 772.5982489105662, 772.7604442622777, 757.75373003774, 762.5196126440335, 763.431243723424, 764.1746913333615, 764.2128607534221, 805.7502174325948, 808.3815880851154, 811.1442428238206, 811.2820154163549, 812.3744716568239, 801.0187520287631, 802.6147449224405, 804.947678400905, 805.8630032894422, 807.6083099696642, 592.3750443282336, 593.4243783530012, 597.4503456819693, 598.5032423088826, 599.7271241585069, 10601.681949541526, 10710.250282480229, 10727.0, 10737.785244295148, 10743.462826858626, 10748.73128171794, 10826.350418974887, 11214.719632009264, 11390.145739069603, 11703.765924681544, 8533.359998000175, 8571.969659214396, 8594.828103437896, 9299.395539289924, 9716.368436051634, 3248.4640034394297, 3258.3646188993157, 3292.522584225298, 3313.204830840581, 3344.414727422691, 34278.82860585681, 34547.654523454694, 34832.6516734832, 37519.24961500809, 40249.0, 8822.955885220661, 8944.150305720947, 8990.325725570608, 9010.50442225684, 9019.909800902038, 14640.414383424544, 14641.0, 14641.48754793577, 14655.92672036633, 14739.63150921214, 5982.192404025488, 6012.488938440281, 6024.759009639565, 6096.512279017668, 6140.293866205444, 3588.964110358915, 3634.164142247298, 3661.9450708239397, 3708.721845861571, 3719.888403347904, 2556.974430255711, 2558.6417901493805, 2570.1390034338706, 2570.408805974599, 2578.3425226567106, 463.677743967939, 471.50727489772584, 471.99700636148185, 472.86286976777035, 477.54394553202303, 552.8396764938122, 557.9442055794469, 559.2282649943053, 565.1522715926111, 590.3624085987124, 7202.459815513857, 7203.639818009184, 7294.744683936143, 7350.264973502607, 8280.296174825087, 547.8520799384144, 560.436761055137, 576.2307319728126, 583.0700033446645, 588.2529187931389, 3333.233356328058, 3349.3468773588916, 3461.3769521486374, 3481.511596775309, 3518.595361533405, 48543.41750698644, 49831.0, 49922.500774991786, 50130.0, 50305.24542131798, 41936.58063419327, 41951.160976780906, 44612.3308150378, 44859.77570112129, 45101.0, 35694.46458303127, 39872.00319992023, 40261.19477610431, 40822.59177408188, 41756.58243417588, 7389.187189409053, 7510.849783004419, 7780.766577002699, 7882.132965373919, 7966.84066318682, 31907.0, 32101.197470063435, 32434.513482297312, 32805.0, 32858.67141328556, 37238.8138059308, 37612.62387376091, 37909.43135853019, 40007.79996100001, 43044.78477607717, 8820.338474614558, 9511.57197926081, 9744.12302892743, 10082.445465499175, 10185.439800811026, 10539.578416863545, 10674.786504270027, 11063.50214240345, 11069.446527673423, 11123.0, 9639.566219519998, 9870.457124858201, 9881.50592470388, 9950.154236889946, 9973.60105595768, 9984.301098923006, 10135.341202821794, 10155.84766228522, 10208.438535880598, 10230.23273254494, 10512.94743526308, 10799.13606911461, 10957.232993690684, 10989.505472253928, 11322.037626801484, 9023.593938272925, 9299.023602521638, 9597.328187026842, 9642.517874106126, 9649.903500965182, 8455.534945578052, 8982.371234013557, 9045.502497362708, 9085.545722713705, 9105.681301154427], "unit": "ms", "name": "yui.html", "value": 5537.003001741545}], "name": "dromaeo_css", "value": 6017.849916123224}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 112.0, 108.0, 114.0, 114.0, 112.0, 104.0, 112.0, 113.0, 106.0], "unit": "ms", "name": "ai-astar", "value": 110.5}, {"lowerIsBetter": true, "replicates": [159.0, 130.0, 158.0, 175.0, 137.0, 169.0, 155.0, 130.0, 166.0, 130.0], "unit": "ms", "name": "audio-beat-detection", "value": 150.9}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 162.0, 162.0, 161.0, 160.0, 161.0, 162.0, 162.0, 162.0], "unit": "ms", "name": "audio-dft", "value": 161.4}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 84.0, 91.0, 73.0, 75.0, 73.0, 113.0, 90.0, 73.0], "unit": "ms", "name": "audio-fft", "value": 81.6}, {"lowerIsBetter": true, "replicates": [94.0, 95.0, 131.0, 93.0, 95.0, 96.0, 134.0, 94.0, 94.0, 128.0], "unit": "ms", "name": "audio-oscillator", "value": 105.4}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 109.0, 109.0, 109.0, 110.0, 110.0, 110.0, 109.0, 113.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.8}, {"lowerIsBetter": true, "replicates": [146.0, 148.0, 146.0, 146.0, 146.0, 147.0, 146.0, 147.0, 147.0, 148.0], "unit": "ms", "name": "imaging-darkroom", "value": 146.7}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 95.0, 96.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.3}, {"lowerIsBetter": true, "replicates": [72.0, 82.0, 72.0, 71.0, 75.0, 71.0, 72.0, 73.0, 71.0, 70.0], "unit": "ms", "name": "json-parse-financial", "value": 72.9}, {"lowerIsBetter": true, "replicates": [71.0, 71.0, 72.0, 71.0, 71.0, 71.0, 70.0, 70.0, 70.0, 71.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 70.8}, {"lowerIsBetter": true, "replicates": [83.0, 85.0, 92.0, 83.0, 83.0, 84.0, 84.0, 84.0, 84.0, 86.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 84.8}, {"lowerIsBetter": true, "replicates": [125.0, 126.0, 128.0, 122.0, 124.0, 125.0, 127.0, 120.0, 125.0, 122.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 124.4}, {"lowerIsBetter": true, "replicates": [150.0, 140.0, 147.0, 146.0, 147.0, 153.0, 149.0, 146.0, 149.0, 141.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 146.8}, {"lowerIsBetter": true, "replicates": [69.0, 69.0, 68.0, 68.0, 68.0, 69.0, 68.0, 69.0, 68.0, 69.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 68.5}], "name": "kraken", "value": 1529.8}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [165.92002654720426], "unit": "score", "name": "Richards", "value": 212.765154}, {"lowerIsBetter": false, "replicates": [191.79133103183736], "unit": "score", "name": "DeltaBlue", "value": 344.73925199999996}, {"lowerIsBetter": false, "replicates": [279.4857462269424], "unit": "score", "name": "Encrypt", "value": 952.3956179999999}, {"lowerIsBetter": false, "replicates": [5202.072538860104], "unit": "score", "name": "Decrypt", "value": 51.16825996015938}, {"lowerIsBetter": false, "replicates": [2057.61316872428], "unit": "score", "name": "RayTrace", "value": 359.63465400000007}, {"lowerIsBetter": false, "replicates": [798.2456140350877], "unit": "score", "name": "Earley", "value": 834.909692307692}, {"lowerIsBetter": false, "replicates": [12370.37037037037], "unit": "score", "name": "Boyer", "value": 53.87575149700595}, {"lowerIsBetter": false, "replicates": [27000.0], "unit": "score", "name": "RegExp", "value": 33.74018518518521}, {"lowerIsBetter": false, "replicates": [701.7543859649123], "unit": "score", "name": "Splay", "value": 116.12467499999994}, {"lowerIsBetter": false, "replicates": [4835.748792270531], "unit": "score", "name": "NavierStokes", "value": 306.881118881119}], "name": "v8_7", "value": 19317.065628992415}]} 07:08:59 INFO - RETURN: dromaeo_css: 6017.85 07:08:59 INFO - RETURN: kraken: 1529.80 07:08:59 INFO - RETURN: v8_7: 19317.07 07:08:59 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,35]]", "result": "19317.07"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,35]]", "result": "1529.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,35]]", "result": "6017.85"}}} 07:09:00 INFO - Return code: 0 07:09:00 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 07:09:00 INFO - # TBPL SUCCESS # 07:09:00 INFO - Running post-action listener: _resource_record_post_action 07:09:00 INFO - Running post-run listener: _resource_record_post_run 07:09:01 INFO - Total resource usage - Wall time: 1235s; CPU: 13.0%; Read bytes: 4096; Write bytes: 501026816; Read time: 16; Write time: 649720 07:09:01 INFO - install - Wall time: 15s; CPU: 14.0%; Read bytes: 0; Write bytes: 229580800; Read time: 0; Write time: 351436 07:09:01 INFO - run-tests - Wall time: 1221s; CPU: 13.0%; Read bytes: 4096; Write bytes: 271446016; Read time: 16; Write time: 298284 07:09:01 INFO - Running post-run listener: _upload_blobber_files 07:09:01 INFO - Blob upload gear active. 07:09:01 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 07:09:01 INFO - Copying logs to upload dir... 07:09:01 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1285.064466 ========= master_lag: 0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 25 secs) (at 2015-11-27 07:08:59.456197) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-27 07:08:59.459828) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.010096 build_url: 'https://queue.taskcluster.net/v1/task/cbe5Z02KRv-fZVmJKVB6DA/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.05 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-27 07:08:59.516912) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 07:08:59.517747) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=d96ba47f58e561e1fc64d816000001cc-1448635041.137549-1794090911 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004503 ========= master_lag: 0.05 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-27 07:08:59.569506) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-27 07:08:59.569855) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-27 07:08:59.570169) ========= ========= Total master_lag: 0.26 =========