builder: fx-team_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-035 starttime: 1448354377.61 results: success (0) buildid: 20151124000443 builduid: cc3120ac02d24544bb21c3199fbe8540 revision: 01d196350d2430972143290226fb0d7866aece78 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.606201) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.606737) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.607066) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006518 basedir: '/builds/slave/test' ========= master_lag: 0.05 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.660159) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.660484) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.699034) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.699337) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004684 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.748489) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.748755) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.749104) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.749372) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2015-11-24 00:39:38-- 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% 212M=0s 2015-11-24 00:39:38 (212 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.166569 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.928845) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.929215) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020248 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.978712) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:37.979058) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 01d196350d2430972143290226fb0d7866aece78 --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 01d196350d2430972143290226fb0d7866aece78 --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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2015-11-24 00:39:38,756 truncating revision to first 12 chars 2015-11-24 00:39:38,756 Setting DEBUG logging. 2015-11-24 00:39:38,756 attempt 1/10 2015-11-24 00:39:38,756 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/01d196350d24?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2015-11-24 00:39:39,012 unpacking tar archive at: fx-team-01d196350d24/testing/mozharness/ program finished with exit code 0 elapsedTime=0.565787 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:38.557267) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:38.557535) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:38.567373) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:38.567620) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2015-11-24 00:39:38.568000) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2015-11-24 00:39:38.568278) ========= /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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 00:39:39 INFO - MultiFileLogger online at 20151124 00:39:39 in /builds/slave/test 00:39:39 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 00:39:39 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 00:39:39 INFO - {'append_to_log': False, 00:39:39 INFO - 'base_work_dir': '/builds/slave/test', 00:39:39 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 00:39:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 00:39:39 INFO - 'branch': 'Fx-Team-Non-PGO', 00:39:39 INFO - 'buildbot_json_path': 'buildprops.json', 00:39:39 INFO - 'config_files': ('talos/linux_config.py',), 00:39:39 INFO - 'default_actions': ('clobber', 00:39:39 INFO - 'read-buildbot-config', 00:39:39 INFO - 'download-and-extract', 00:39:39 INFO - 'populate-webroot', 00:39:39 INFO - 'create-virtualenv', 00:39:39 INFO - 'install', 00:39:39 INFO - 'run-tests'), 00:39:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 00:39:39 INFO - 'download_minidump_stackwalk': True, 00:39:39 INFO - 'download_symbols': 'ondemand', 00:39:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 00:39:39 INFO - 'tooltool.py': '/tools/tooltool.py', 00:39:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 00:39:39 INFO - '/tools/misc-python/virtualenv.py')}, 00:39:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 00:39:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 00:39:39 INFO - 'installer_path': 'installer.exe', 00:39:39 INFO - 'log_level': 'info', 00:39:39 INFO - 'log_name': 'talos', 00:39:39 INFO - 'log_to_console': True, 00:39:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 00:39:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 00:39:39 INFO - 'opt_config_files': (), 00:39:39 INFO - 'pip_index': False, 00:39:39 INFO - 'sps_profile': False, 00:39:39 INFO - 'sps_profile_interval': 0, 00:39:39 INFO - 'suite': 'dromaeojs', 00:39:39 INFO - 'system_bits': '64', 00:39:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 00:39:39 INFO - 'title': 'talos-linux64-ix-035', 00:39:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 00:39:39 INFO - 'use_talos_json': True, 00:39:39 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 00:39:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 00:39:39 INFO - 'work_dir': 'build'} 00:39:39 INFO - ##### 00:39:39 INFO - ##### Running clobber step. 00:39:39 INFO - ##### 00:39:39 INFO - Running pre-action listener: _resource_record_pre_action 00:39:39 INFO - Running main action method: clobber 00:39:39 INFO - rmtree: /builds/slave/test/build 00:39:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 00:39:40 INFO - Running post-action listener: _resource_record_post_action 00:39:40 INFO - ##### 00:39:40 INFO - ##### Running read-buildbot-config step. 00:39:40 INFO - ##### 00:39:40 INFO - Running pre-action listener: _resource_record_pre_action 00:39:40 INFO - Running main action method: read_buildbot_config 00:39:40 INFO - Using buildbot properties: 00:39:40 INFO - { 00:39:40 INFO - "properties": { 00:39:40 INFO - "buildnumber": 2116, 00:39:40 INFO - "product": "firefox", 00:39:40 INFO - "script_repo_revision": "production", 00:39:40 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs", 00:39:40 INFO - "repository": "", 00:39:40 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs", 00:39:40 INFO - "buildid": "20151124000443", 00:39:40 INFO - "slavename": "talos-linux64-ix-035", 00:39:40 INFO - "pgo_build": "False", 00:39:40 INFO - "basedir": "/builds/slave/test", 00:39:40 INFO - "project": "", 00:39:40 INFO - "platform": "ubuntu64_hw", 00:39:40 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 00:39:40 INFO - "slavebuilddir": "test", 00:39:40 INFO - "scheduler": "tests-fx-team-linux64-talos", 00:39:40 INFO - "branch": "fx-team", 00:39:40 INFO - "repo_path": "integration/fx-team", 00:39:40 INFO - "stage_platform": "linux64", 00:39:40 INFO - "builduid": "cc3120ac02d24544bb21c3199fbe8540", 00:39:40 INFO - "revision": "01d196350d2430972143290226fb0d7866aece78" 00:39:40 INFO - }, 00:39:40 INFO - "sourcestamp": { 00:39:40 INFO - "repository": "", 00:39:40 INFO - "hasPatch": false, 00:39:40 INFO - "project": "", 00:39:40 INFO - "branch": "fx-team-linux64-talos", 00:39:40 INFO - "changes": [ 00:39:40 INFO - { 00:39:40 INFO - "category": null, 00:39:40 INFO - "files": [ 00:39:40 INFO - { 00:39:40 INFO - "url": null, 00:39:40 INFO - "name": "https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2" 00:39:40 INFO - } 00:39:40 INFO - ], 00:39:40 INFO - "repository": "", 00:39:40 INFO - "rev": "01d196350d2430972143290226fb0d7866aece78", 00:39:40 INFO - "who": "cbook@mozilla.com", 00:39:40 INFO - "when": 1448354348, 00:39:40 INFO - "number": 6699330, 00:39:40 INFO - "comments": "Bug 1209341 - allow loading unsigned restartless add-ons at runtime. r=mossop", 00:39:40 INFO - "project": "", 00:39:40 INFO - "at": "Tue 24 Nov 2015 00:39:08", 00:39:40 INFO - "branch": "fx-team-linux64-talos", 00:39:40 INFO - "revlink": "", 00:39:40 INFO - "properties": [ 00:39:40 INFO - [ 00:39:40 INFO - "buildid", 00:39:40 INFO - "20151124000443", 00:39:40 INFO - "Change" 00:39:40 INFO - ], 00:39:40 INFO - [ 00:39:40 INFO - "builduid", 00:39:40 INFO - "cc3120ac02d24544bb21c3199fbe8540", 00:39:40 INFO - "Change" 00:39:40 INFO - ], 00:39:40 INFO - [ 00:39:40 INFO - "pgo_build", 00:39:40 INFO - "False", 00:39:40 INFO - "Change" 00:39:40 INFO - ] 00:39:40 INFO - ], 00:39:40 INFO - "revision": "01d196350d2430972143290226fb0d7866aece78" 00:39:40 INFO - } 00:39:40 INFO - ], 00:39:40 INFO - "revision": "01d196350d2430972143290226fb0d7866aece78" 00:39:40 INFO - } 00:39:40 INFO - } 00:39:40 INFO - Found installer url https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2. 00:39:40 INFO - Running post-action listener: _resource_record_post_action 00:39:40 INFO - ##### 00:39:40 INFO - ##### Running download-and-extract step. 00:39:40 INFO - ##### 00:39:40 INFO - Running pre-action listener: _resource_record_pre_action 00:39:40 INFO - Running main action method: download_and_extract 00:39:40 INFO - mkdir: /builds/slave/test/build/tests 00:39:40 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')]} 00:39:40 INFO - https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 00:39:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/test_packages.json 00:39:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/test_packages.json 00:39:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 00:39:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 00:39:44 INFO - Downloaded 1302 bytes. 00:39:44 INFO - Reading from file /builds/slave/test/build/test_packages.json 00:39:44 INFO - Using the following test package requirements: 00:39:44 INFO - {u'common': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 00:39:44 INFO - u'cppunittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:39:44 INFO - u'firefox-45.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 00:39:44 INFO - u'jittest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:39:44 INFO - u'jsshell-linux-x86_64.zip'], 00:39:44 INFO - u'mochitest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:39:44 INFO - u'firefox-45.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 00:39:44 INFO - u'mozbase': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 00:39:44 INFO - u'reftest': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:39:44 INFO - u'firefox-45.0a1.en-US.linux-x86_64.reftest.tests.zip'], 00:39:44 INFO - u'talos': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:39:44 INFO - u'firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip'], 00:39:44 INFO - u'web-platform': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:39:44 INFO - u'firefox-45.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 00:39:44 INFO - u'webapprt': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'], 00:39:44 INFO - u'xpcshell': [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip', 00:39:44 INFO - u'firefox-45.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 00:39:44 INFO - Downloading packages: [u'firefox-45.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 00:39:44 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')]} 00:39:44 INFO - https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 00:39:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:39:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:39:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:48 INFO - Downloaded 21341300 bytes. 00:39:48 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 00:39:48 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:39:48 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 00:39:49 INFO - Return code: 0 00:39:49 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 00:39:49 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')]} 00:39:49 INFO - https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 00:39:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:39:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:39:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:51 INFO - Downloaded 21341300 bytes. 00:39:51 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 00:39:51 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.common.tests.zip 00:39:51 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 00:39:52 INFO - Return code: 0 00:39:52 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')]} 00:39:52 INFO - https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 00:39:52 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 00:39:52 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 00:39:52 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:52 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:53 INFO - Downloaded 11130997 bytes. 00:39:53 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 00:39:53 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-45.0a1.en-US.linux-x86_64.talos.tests.zip 00:39:53 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 00:39:53 INFO - Return code: 0 00:39:53 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')]} 00:39:53 INFO - https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 00:39:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:39:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:39:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/AQWMZMQpQ7KVAuhl38f58Q/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 00:39:55 INFO - Downloaded 56070162 bytes. 00:39:55 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:39:55 INFO - mkdir: /builds/slave/test/properties 00:39:55 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 00:39:55 INFO - Writing to file /builds/slave/test/properties/build_url 00:39:55 INFO - Contents: 00:39:55 INFO - build_url:https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 00:39:55 INFO - Running post-action listener: _resource_record_post_action 00:39:55 INFO - Running post-action listener: set_extra_try_arguments 00:39:55 INFO - ##### 00:39:55 INFO - ##### Running populate-webroot step. 00:39:55 INFO - ##### 00:39:55 INFO - Running pre-action listener: _resource_record_pre_action 00:39:55 INFO - Running main action method: populate_webroot 00:39:55 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 00:39:55 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 00:39:55 INFO - 'remote-trobocheck2': {'talos_options': ['--fennecIDs', 00:39:55 INFO - '../fennec_ids.txt'], 00:39:55 INFO - 'tests': ['tcheck2']}, 00:39:55 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 00:39:55 INFO - '--tppagecycles', 00:39:55 INFO - '7'], 00:39:55 INFO - 'tests': ['tsvgm']}}, 00:39:55 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 00:39:55 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['tresize', 'tcanvasmark']}, 00:39:55 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 00:39:55 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 00:39:55 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 00:39:55 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 00:39:55 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'tests': ['damp', 'tps']}, 00:39:55 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['damp', 'tps']}, 00:39:55 INFO - 'g3': {'tests': ['dromaeo_dom']}, 00:39:55 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 00:39:55 INFO - 'other': {'tests': ['a11yr', 00:39:55 INFO - 'ts_paint', 00:39:55 INFO - 'tpaint', 00:39:55 INFO - 'sessionrestore', 00:39:55 INFO - 'sessionrestore_no_auto_restore']}, 00:39:55 INFO - 'other-e10s': {'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['a11yr', 00:39:55 INFO - 'ts_paint', 00:39:55 INFO - 'tpaint', 00:39:55 INFO - 'sessionrestore', 00:39:55 INFO - 'sessionrestore_no_auto_restore']}, 00:39:55 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['a11yr', 00:39:55 INFO - 'ts_paint', 00:39:55 INFO - 'tpaint', 00:39:55 INFO - 'sessionrestore', 00:39:55 INFO - 'sessionrestore_no_auto_restore']}, 00:39:55 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['a11yr', 00:39:55 INFO - 'ts_paint', 00:39:55 INFO - 'tpaint', 00:39:55 INFO - 'sessionrestore', 00:39:55 INFO - 'sessionrestore_no_auto_restore']}, 00:39:55 INFO - 'other_l64': {'tests': ['a11yr', 00:39:55 INFO - 'ts_paint', 00:39:55 INFO - 'tpaint', 00:39:55 INFO - 'sessionrestore', 00:39:55 INFO - 'sessionrestore_no_auto_restore']}, 00:39:55 INFO - 'other_nol64': {'tests': ['a11yr', 00:39:55 INFO - 'ts_paint', 00:39:55 INFO - 'tpaint', 00:39:55 INFO - 'sessionrestore', 00:39:55 INFO - 'sessionrestore_no_auto_restore']}, 00:39:55 INFO - 'svgr': {'tests': ['tsvgx', 00:39:55 INFO - 'tsvgr_opacity', 00:39:55 INFO - 'tart', 00:39:55 INFO - 'tscrollx', 00:39:55 INFO - 'cart']}, 00:39:55 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['tsvgx', 00:39:55 INFO - 'tsvgr_opacity', 00:39:55 INFO - 'tart', 00:39:55 INFO - 'tscrollx', 00:39:55 INFO - 'cart']}, 00:39:55 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'tests': ['tp5o']}, 00:39:55 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'talos_options': ['--e10s'], 00:39:55 INFO - 'tests': ['tp5o']}, 00:39:55 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'talos_options': ['--xperf_path', 00:39:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 00:39:55 INFO - 'tests': ['tp5n']}, 00:39:55 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 00:39:55 INFO - 'talos_options': ['--e10s', 00:39:55 INFO - '--xperf_path', 00:39:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 00:39:55 INFO - 'tests': ['tp5n']}}, 00:39:55 INFO - 'talos.zip': {'path': '', 00:39:55 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 00:39:55 INFO - Running post-action listener: _resource_record_post_action 00:39:55 INFO - ##### 00:39:55 INFO - ##### Running create-virtualenv step. 00:39:55 INFO - ##### 00:39:55 INFO - Running pre-action listener: _resource_record_pre_action 00:39:55 INFO - Running main action method: create_virtualenv 00:39:55 INFO - Creating virtualenv /builds/slave/test/build/venv 00:39:55 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 00:39:55 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 00:39:55 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 00:39:55 INFO - Using real prefix '/usr' 00:39:55 INFO - New python executable in /builds/slave/test/build/venv/bin/python 00:39:55 INFO - Installing distribute.............................................................................................................................................................................................done. 00:39:57 INFO - Installing pip.................done. 00:39:57 INFO - Return code: 0 00:39:57 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 00:39:57 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')]} 00:39:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:39:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:39:57 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')]} 00:39:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:39:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:39:57 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 0x7fd55a1fdc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23266c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23d7900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', '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 00:39:57 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 00:39:57 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 00:39:57 INFO - Using env: {'DISPLAY': ':0', 00:39:57 INFO - 'HOME': '/home/cltbld', 00:39:57 INFO - 'LANG': 'en_US.UTF-8', 00:39:57 INFO - 'LANGUAGE': 'en_US:en', 00:39:57 INFO - 'LOGNAME': 'cltbld', 00:39:57 INFO - 'MAIL': '/var/mail/cltbld', 00:39:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:39:57 INFO - 'MOZ_NO_REMOTE': '1', 00:39:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:39:57 INFO - 'NO_EM_RESTART': '1', 00:39:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:39:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:39:57 INFO - 'PWD': '/builds/slave/test', 00:39:57 INFO - 'SHELL': '/bin/bash', 00:39:57 INFO - 'SHLVL': '1', 00:39:57 INFO - 'TERM': 'linux', 00:39:57 INFO - 'TMOUT': '86400', 00:39:57 INFO - 'USER': 'cltbld', 00:39:57 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:39:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:39:57 INFO - '_': '/tools/buildbot/bin/python'} 00:39:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:39:57 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 00:39:57 INFO - Cleaning up... 00:39:57 INFO - Return code: 0 00:39:57 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 00:39:57 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')]} 00:39:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:39:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:39:57 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')]} 00:39:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:39:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:39:57 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 0x7fd55a1fdc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23266c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23d7900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', '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 00:39:57 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 00:39:57 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 00:39:57 INFO - Using env: {'DISPLAY': ':0', 00:39:57 INFO - 'HOME': '/home/cltbld', 00:39:57 INFO - 'LANG': 'en_US.UTF-8', 00:39:57 INFO - 'LANGUAGE': 'en_US:en', 00:39:57 INFO - 'LOGNAME': 'cltbld', 00:39:57 INFO - 'MAIL': '/var/mail/cltbld', 00:39:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:39:57 INFO - 'MOZ_NO_REMOTE': '1', 00:39:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:39:57 INFO - 'NO_EM_RESTART': '1', 00:39:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:39:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:39:57 INFO - 'PWD': '/builds/slave/test', 00:39:57 INFO - 'SHELL': '/bin/bash', 00:39:57 INFO - 'SHLVL': '1', 00:39:57 INFO - 'TERM': 'linux', 00:39:57 INFO - 'TMOUT': '86400', 00:39:57 INFO - 'USER': 'cltbld', 00:39:57 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:39:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:39:57 INFO - '_': '/tools/buildbot/bin/python'} 00:39:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:39:58 INFO - Downloading/unpacking psutil>=0.7.1 00:39:58 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 00:39:58 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 00:39:58 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 00:39:58 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 00:39:58 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 00:39:58 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 00:39:59 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 00:39:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 00:39:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 00:39:59 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 00:39:59 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 00:39:59 INFO - Installing collected packages: psutil 00:39:59 INFO - Running setup.py install for psutil 00:39:59 INFO - building 'psutil._psutil_linux' extension 00:39:59 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 00:40:00 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 00:40:00 INFO - building 'psutil._psutil_posix' extension 00:40:00 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 00:40:00 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 00:40:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 00:40:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 00:40:00 INFO - Successfully installed psutil 00:40:00 INFO - Cleaning up... 00:40:00 INFO - Return code: 0 00:40:00 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 00:40: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')]} 00:40:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:40:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40: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')]} 00:40:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:40:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:00 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 0x7fd55a1fdc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23266c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23d7900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', '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 00:40:00 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 00:40:00 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 00:40:00 INFO - Using env: {'DISPLAY': ':0', 00:40:00 INFO - 'HOME': '/home/cltbld', 00:40:00 INFO - 'LANG': 'en_US.UTF-8', 00:40:00 INFO - 'LANGUAGE': 'en_US:en', 00:40:00 INFO - 'LOGNAME': 'cltbld', 00:40:00 INFO - 'MAIL': '/var/mail/cltbld', 00:40:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:40:00 INFO - 'MOZ_NO_REMOTE': '1', 00:40:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:40:00 INFO - 'NO_EM_RESTART': '1', 00:40:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:40:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:40:00 INFO - 'PWD': '/builds/slave/test', 00:40:00 INFO - 'SHELL': '/bin/bash', 00:40:00 INFO - 'SHLVL': '1', 00:40:00 INFO - 'TERM': 'linux', 00:40:00 INFO - 'TMOUT': '86400', 00:40:00 INFO - 'USER': 'cltbld', 00:40:00 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:40:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:40:00 INFO - '_': '/tools/buildbot/bin/python'} 00:40:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:40:00 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 00:40:00 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 00:40:00 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 00:40:00 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 00:40:00 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 00:40:00 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 00:40:00 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 00:40:02 INFO - Downloading mozsystemmonitor-0.0.tar.gz 00:40:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 00:40:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 00:40:02 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 00:40:02 INFO - Installing collected packages: mozsystemmonitor 00:40:02 INFO - Running setup.py install for mozsystemmonitor 00:40:02 INFO - Successfully installed mozsystemmonitor 00:40:02 INFO - Cleaning up... 00:40:02 INFO - Return code: 0 00:40:02 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 00:40:02 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')]} 00:40:02 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:40:02 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:02 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')]} 00:40:02 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:40:02 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:02 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 0x7fd55a1fdc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23266c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23d7900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', '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 00:40:02 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 00:40:02 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 00:40:02 INFO - Using env: {'DISPLAY': ':0', 00:40:02 INFO - 'HOME': '/home/cltbld', 00:40:02 INFO - 'LANG': 'en_US.UTF-8', 00:40:02 INFO - 'LANGUAGE': 'en_US:en', 00:40:02 INFO - 'LOGNAME': 'cltbld', 00:40:02 INFO - 'MAIL': '/var/mail/cltbld', 00:40:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:40:02 INFO - 'MOZ_NO_REMOTE': '1', 00:40:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:40:02 INFO - 'NO_EM_RESTART': '1', 00:40:02 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:40:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:40:02 INFO - 'PWD': '/builds/slave/test', 00:40:02 INFO - 'SHELL': '/bin/bash', 00:40:02 INFO - 'SHLVL': '1', 00:40:02 INFO - 'TERM': 'linux', 00:40:02 INFO - 'TMOUT': '86400', 00:40:02 INFO - 'USER': 'cltbld', 00:40:02 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:40:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:40:02 INFO - '_': '/tools/buildbot/bin/python'} 00:40:02 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:40:02 INFO - Downloading/unpacking blobuploader==1.2.4 00:40:02 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 00:40:02 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 00:40:02 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 00:40:02 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 00:40:02 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 00:40:02 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 00:40:04 INFO - Downloading blobuploader-1.2.4.tar.gz 00:40:04 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 00:40:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 00:40:04 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 00:40: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 00:40: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 00:40: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 00:40: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 00:40: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 00:40: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 00:40:04 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 00:40:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 00:40:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 00:40: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 00:40: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 00:40: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 00:40: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 00:40: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 00:40: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 00:40:05 INFO - Downloading docopt-0.6.1.tar.gz 00:40:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 00:40:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 00:40:05 INFO - Installing collected packages: blobuploader, requests, docopt 00:40:05 INFO - Running setup.py install for blobuploader 00:40:05 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 00:40:05 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 00:40:05 INFO - Running setup.py install for requests 00:40:05 INFO - Running setup.py install for docopt 00:40:05 INFO - Successfully installed blobuploader requests docopt 00:40:05 INFO - Cleaning up... 00:40:05 INFO - Return code: 0 00:40:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 00:40:05 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')]} 00:40:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:40:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:05 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')]} 00:40:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:40:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:05 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 0x7fd55a1fdc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23266c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23d7900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', '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 00:40:05 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 00:40:05 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 00:40:05 INFO - Using env: {'DISPLAY': ':0', 00:40:05 INFO - 'HOME': '/home/cltbld', 00:40:05 INFO - 'LANG': 'en_US.UTF-8', 00:40:05 INFO - 'LANGUAGE': 'en_US:en', 00:40:05 INFO - 'LOGNAME': 'cltbld', 00:40:05 INFO - 'MAIL': '/var/mail/cltbld', 00:40:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:40:05 INFO - 'MOZ_NO_REMOTE': '1', 00:40:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:40:05 INFO - 'NO_EM_RESTART': '1', 00:40:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:40:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:40:05 INFO - 'PWD': '/builds/slave/test', 00:40:05 INFO - 'SHELL': '/bin/bash', 00:40:05 INFO - 'SHLVL': '1', 00:40:05 INFO - 'TERM': 'linux', 00:40:05 INFO - 'TMOUT': '86400', 00:40:05 INFO - 'USER': 'cltbld', 00:40:05 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:40:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:40:05 INFO - '_': '/tools/buildbot/bin/python'} 00:40:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:40:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 00:40:05 INFO - Running setup.py (path:/tmp/pip-_e1byd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 00:40:06 INFO - Running setup.py (path:/tmp/pip-Nwil7B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 00:40:06 INFO - Running setup.py (path:/tmp/pip-2N1mBm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 00:40:06 INFO - Running setup.py (path:/tmp/pip-YKFqTJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 00:40:06 INFO - Running setup.py (path:/tmp/pip-85eMA4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 00:40:06 INFO - Running setup.py (path:/tmp/pip-aw30S8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 00:40:06 INFO - Running setup.py (path:/tmp/pip-P0dU98-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 00:40:06 INFO - Running setup.py (path:/tmp/pip-nVaRu4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 00:40:06 INFO - Running setup.py (path:/tmp/pip-SioAMW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 00:40:06 INFO - Running setup.py (path:/tmp/pip-IVExcG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 00:40:06 INFO - Running setup.py (path:/tmp/pip-yQUwNg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 00:40:06 INFO - Running setup.py (path:/tmp/pip-bPYOhi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 00:40:06 INFO - Running setup.py (path:/tmp/pip-SufJWO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 00:40:06 INFO - Running setup.py (path:/tmp/pip-vSwXyh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 00:40:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 00:40:06 INFO - Running setup.py (path:/tmp/pip-EMX5fa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 00:40:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 00:40:07 INFO - Running setup.py (path:/tmp/pip-BMbLSl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 00:40:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 00:40:07 INFO - Running setup.py (path:/tmp/pip-doK6xB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 00:40:07 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 00:40:07 INFO - Running setup.py install for manifestparser 00:40:07 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Running setup.py install for mozcrash 00:40:07 INFO - Running setup.py install for mozdebug 00:40:07 INFO - Running setup.py install for mozdevice 00:40:07 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Installing dm script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Running setup.py install for mozfile 00:40:07 INFO - Running setup.py install for mozhttpd 00:40:07 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Running setup.py install for mozinfo 00:40:07 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Running setup.py install for mozInstall 00:40:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 00:40:07 INFO - Running setup.py install for mozleak 00:40:08 INFO - Running setup.py install for mozlog 00:40:08 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 00:40:08 INFO - Running setup.py install for moznetwork 00:40:08 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 00:40:08 INFO - Running setup.py install for mozprocess 00:40:08 INFO - Running setup.py install for mozprofile 00:40:08 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 00:40:08 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 00:40:08 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 00:40:08 INFO - Running setup.py install for mozrunner 00:40:08 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 00:40:08 INFO - Running setup.py install for mozscreenshot 00:40:08 INFO - Running setup.py install for moztest 00:40:08 INFO - Running setup.py install for mozversion 00:40:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 00:40:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 00:40:08 INFO - Cleaning up... 00:40:08 INFO - Return code: 0 00:40:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 00:40:08 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')]} 00:40:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:40:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:08 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')]} 00:40:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:40:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:08 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 0x7fd55a1fdc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23266c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23d7900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', '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 00:40:08 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 00:40:08 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 00:40:08 INFO - Using env: {'DISPLAY': ':0', 00:40:08 INFO - 'HOME': '/home/cltbld', 00:40:08 INFO - 'LANG': 'en_US.UTF-8', 00:40:08 INFO - 'LANGUAGE': 'en_US:en', 00:40:08 INFO - 'LOGNAME': 'cltbld', 00:40:08 INFO - 'MAIL': '/var/mail/cltbld', 00:40:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:40:08 INFO - 'MOZ_NO_REMOTE': '1', 00:40:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:40:08 INFO - 'NO_EM_RESTART': '1', 00:40:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:40:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:40:08 INFO - 'PWD': '/builds/slave/test', 00:40:08 INFO - 'SHELL': '/bin/bash', 00:40:08 INFO - 'SHLVL': '1', 00:40:08 INFO - 'TERM': 'linux', 00:40:08 INFO - 'TMOUT': '86400', 00:40:08 INFO - 'USER': 'cltbld', 00:40:08 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:40:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:40:08 INFO - '_': '/tools/buildbot/bin/python'} 00:40:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 00:40:09 INFO - Running setup.py (path:/tmp/pip-WfJPo5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 00:40:09 INFO - Running setup.py (path:/tmp/pip-3XYIaF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 00:40:09 INFO - Running setup.py (path:/tmp/pip-TE99ed-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 00:40:09 INFO - Running setup.py (path:/tmp/pip-y48vpI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 00:40:09 INFO - Running setup.py (path:/tmp/pip-hM6Wn4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 00:40:09 INFO - Running setup.py (path:/tmp/pip-V5UeqR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 00:40:09 INFO - Running setup.py (path:/tmp/pip-i5N_Pu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 00:40:09 INFO - Running setup.py (path:/tmp/pip-ADs5S9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 00:40:09 INFO - Running setup.py (path:/tmp/pip-VW0eZR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 00:40:09 INFO - Running setup.py (path:/tmp/pip-HM4CeP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 00:40:09 INFO - Running setup.py (path:/tmp/pip-rqSR5b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 00:40:09 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)) 00:40:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 00:40:09 INFO - Running setup.py (path:/tmp/pip-X3AzB7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 00:40:10 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)) 00:40:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 00:40:10 INFO - Running setup.py (path:/tmp/pip-HAkB1J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 00:40:10 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)) 00:40:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 00:40:10 INFO - Running setup.py (path:/tmp/pip-J3FDTg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 00:40:10 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)) 00:40:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 00:40:10 INFO - Running setup.py (path:/tmp/pip-2PGj_I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 00:40:10 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)) 00:40:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 00:40:10 INFO - Running setup.py (path:/tmp/pip-wldocE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 00:40:10 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)) 00:40:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 00:40:10 INFO - Running setup.py (path:/tmp/pip-V1wBjd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 00:40:10 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)) 00:40:10 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)) 00:40:10 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)) 00:40:10 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)) 00:40:10 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)) 00:40:10 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)) 00:40:10 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 00:40:10 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 00:40:10 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 00:40:10 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 00:40:10 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 00:40:10 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 00:40:10 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 00:40:12 INFO - Downloading blessings-1.5.1.tar.gz 00:40:12 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 00:40:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 00:40:12 INFO - Installing collected packages: blessings 00:40:12 INFO - Running setup.py install for blessings 00:40:12 INFO - Successfully installed blessings 00:40:12 INFO - Cleaning up... 00:40:12 INFO - Return code: 0 00:40:12 INFO - Done creating virtualenv /builds/slave/test/build/venv. 00:40:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 00:40:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 00:40:12 INFO - Reading from file tmpfile_stdout 00:40:12 INFO - Current package versions: 00:40:12 INFO - argparse == 1.2.1 00:40:12 INFO - blessings == 1.5.1 00:40:12 INFO - blobuploader == 1.2.4 00:40:12 INFO - docopt == 0.6.1 00:40:12 INFO - manifestparser == 1.1 00:40:12 INFO - mozInstall == 1.12 00:40:12 INFO - mozcrash == 0.16 00:40:12 INFO - mozdebug == 0.1 00:40:12 INFO - mozdevice == 0.47 00:40:12 INFO - mozfile == 1.2 00:40:12 INFO - mozhttpd == 0.7 00:40:12 INFO - mozinfo == 0.9 00:40:12 INFO - mozleak == 0.1 00:40:12 INFO - mozlog == 3.1 00:40:12 INFO - moznetwork == 0.27 00:40:12 INFO - mozprocess == 0.22 00:40:12 INFO - mozprofile == 0.27 00:40:12 INFO - mozrunner == 6.11 00:40:12 INFO - mozscreenshot == 0.1 00:40:12 INFO - mozsystemmonitor == 0.0 00:40:12 INFO - moztest == 0.7 00:40:12 INFO - mozversion == 1.4 00:40:12 INFO - psutil == 3.1.1 00:40:12 INFO - requests == 1.2.3 00:40:12 INFO - wsgiref == 0.1.2 00:40:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 00:40: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')]} 00:40:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:40:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40: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')]} 00:40:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:40:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:40:12 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 0x7fd55a1fdc70>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23266c0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x23d7900>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, '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': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', '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 00:40:12 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 00:40:12 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 00:40:12 INFO - Using env: {'DISPLAY': ':0', 00:40:12 INFO - 'HOME': '/home/cltbld', 00:40:12 INFO - 'LANG': 'en_US.UTF-8', 00:40:12 INFO - 'LANGUAGE': 'en_US:en', 00:40:12 INFO - 'LOGNAME': 'cltbld', 00:40:12 INFO - 'MAIL': '/var/mail/cltbld', 00:40:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:40:12 INFO - 'MOZ_NO_REMOTE': '1', 00:40:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:40:12 INFO - 'NO_EM_RESTART': '1', 00:40:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:40:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:40:12 INFO - 'PWD': '/builds/slave/test', 00:40:12 INFO - 'SHELL': '/bin/bash', 00:40:12 INFO - 'SHLVL': '1', 00:40:12 INFO - 'TERM': 'linux', 00:40:12 INFO - 'TMOUT': '86400', 00:40:12 INFO - 'USER': 'cltbld', 00:40:12 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:40:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:40:12 INFO - '_': '/tools/buildbot/bin/python'} 00:40:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 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)) 00:40:12 INFO - Cleaning up... 00:40:12 INFO - Return code: 0 00:40:12 INFO - Running post-action listener: _resource_record_post_action 00:40:12 INFO - Running post-action listener: _start_resource_monitoring 00:40:12 INFO - Starting resource monitoring. 00:40:12 INFO - ##### 00:40:12 INFO - ##### Running install step. 00:40:12 INFO - ##### 00:40:12 INFO - Running pre-action listener: _resource_record_pre_action 00:40:12 INFO - Running main action method: install 00:40:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 00:40:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 00:40:12 INFO - Reading from file tmpfile_stdout 00:40:12 INFO - Detecting whether we're running mozinstall >=1.0... 00:40:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 00:40:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 00:40:13 INFO - Reading from file tmpfile_stdout 00:40:13 INFO - Output received: 00:40:13 INFO - Usage: mozinstall [options] installer 00:40:13 INFO - Options: 00:40:13 INFO - -h, --help show this help message and exit 00:40:13 INFO - -d DEST, --destination=DEST 00:40:13 INFO - Directory to install application into. [default: 00:40:13 INFO - "/builds/slave/test"] 00:40:13 INFO - --app=APP Application being installed. [default: firefox] 00:40:13 INFO - mkdir: /builds/slave/test/build/application 00:40:13 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'] 00:40:13 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 00:40:27 INFO - Reading from file tmpfile_stdout 00:40:27 INFO - Output received: 00:40:27 INFO - /builds/slave/test/build/application/firefox/firefox 00:40:27 INFO - Running post-action listener: _resource_record_post_action 00:40:27 INFO - ##### 00:40:27 INFO - ##### Running run-tests step. 00:40:27 INFO - ##### 00:40:27 INFO - Running pre-action listener: _resource_record_pre_action 00:40:27 INFO - Running main action method: run_tests 00:40:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 00:40:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 00:40:27 INFO - Python 2.7.3 00:40:27 INFO - Return code: 0 00:40:27 INFO - grabbing minidump binary from tooltool 00:40:27 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')]} 00:40:27 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 0x241db70>, '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 0x246edc0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x246f250>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 00:40:27 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 00:40:27 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 00:40:27 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 00:40:27 INFO - Return code: 0 00:40:27 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 00:40:27 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 00:40:27 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 00:40:27 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 00:40:27 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 00:40:27 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/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost'] in /builds/slave/test/build 00:40:27 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/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-035 --webServer localhost 00:40:27 INFO - Using env: {'DISPLAY': ':0', 00:40:27 INFO - 'HOME': '/home/cltbld', 00:40:27 INFO - 'LANG': 'en_US.UTF-8', 00:40:27 INFO - 'LANGUAGE': 'en_US:en', 00:40:27 INFO - 'LOGNAME': 'cltbld', 00:40:27 INFO - 'MAIL': '/var/mail/cltbld', 00:40:27 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 00:40:27 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 00:40:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:40:27 INFO - 'MOZ_NO_REMOTE': '1', 00:40:27 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 00:40:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:40:27 INFO - 'NO_EM_RESTART': '1', 00:40:27 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:40:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:40:27 INFO - 'PWD': '/builds/slave/test', 00:40:27 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 00:40:27 INFO - 'SHELL': '/bin/bash', 00:40:27 INFO - 'SHLVL': '1', 00:40:27 INFO - 'TERM': 'linux', 00:40:27 INFO - 'TMOUT': '86400', 00:40:27 INFO - 'USER': 'cltbld', 00:40:27 INFO - 'XDG_SESSION_COOKIE': '0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658', 00:40:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:40:27 INFO - '_': '/tools/buildbot/bin/python'} 00:40:27 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/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost'] with output_timeout 3600 00:40:27 INFO - mozversion INFO | application_buildid: 20151124000443 00:40:27 INFO - mozversion INFO | application_changeset: 01d196350d2430972143290226fb0d7866aece78 00:40:27 INFO - mozversion INFO | application_display_name: Nightly 00:40:27 INFO - mozversion INFO | application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 00:40:27 INFO - mozversion INFO | application_name: Firefox 00:40:27 INFO - mozversion INFO | application_remotingname: firefox 00:40:27 INFO - mozversion INFO | application_repository: https://hg.mozilla.org/integration/fx-team 00:40:27 INFO - mozversion INFO | application_vendor: Mozilla 00:40:27 INFO - mozversion INFO | application_version: 45.0a1 00:40:27 INFO - mozversion INFO | platform_buildid: 20151124000443 00:40:27 INFO - mozversion INFO | platform_changeset: 01d196350d2430972143290226fb0d7866aece78 00:40:27 INFO - mozversion INFO | platform_repository: https://hg.mozilla.org/integration/fx-team 00:40:27 INFO - mozversion INFO | platform_version: 45.0a1 00:40:27 INFO - 2015-11-24 00:40:27,446 DEBUG : using testdate: 1448354427 00:40:27 INFO - 2015-11-24 00:40:27,446 DEBUG : actual date: 1448354427 00:40:27 INFO - 2015-11-24 00:40:27,523 INFO : starting webserver on 'localhost:58543' 00:40:27 INFO - 2015-11-24 00:40:27,524 INFO : Starting test suite talos-linux64-ix-035 00:40:27 INFO - 2015-11-24 00:40:27,524 INFO : Starting test dromaeo_css 00:40:27 INFO - 2015-11-24 00:40:27,524 DEBUG : operating with platform_type : linux_ 00:40:27 INFO - 2015-11-24 00:40:27,525 INFO : Initialising browser for dromaeo_css test... 00:40:27 INFO - 2015-11-24 00:40:27,539 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpeJ9QcR/profile http://localhost:58543/getInfo.html 00:40:32 INFO - 2015-11-24 00:40:32,527 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 00:40:32 INFO - 2015-11-24 00:40:32,527 DEBUG : BROWSER_OUTPUT: colorDepth:24 00:40:32 INFO - 2015-11-24 00:40:32,527 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 00:40:32 INFO - 2015-11-24 00:40:32,527 DEBUG : BROWSER_OUTPUT: __metrics 00:40:32 INFO - 2015-11-24 00:40:32,684 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 00:40:33 INFO - 2015-11-24 00:40:33,959 INFO : Browser initialized. 00:40:33 INFO - 2015-11-24 00:40:33,959 INFO : Running cycle 1/1 for dromaeo_css test... 00:40:33 INFO - 2015-11-24 00:40:33,959 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpeJ9QcR/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 00:40:45 INFO - 2015-11-24 00:40:45,916 DEBUG : BROWSER_OUTPUT: RSS: Main: 141459456 00:40:45 INFO - 2015-11-24 00:40:45,916 DEBUG : BROWSER_OUTPUT: 00:41:37 INFO - 2015-11-24 00:41:37,072 DEBUG : BROWSER_OUTPUT: 1448354497065 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] 00:43:49 INFO - 2015-11-24 00:43:49,134 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/dromaeo/cssquery-dojo.html (next: http://localhost:58543/tests/dromaeo/cssquery-ext.html) 00:43:50 INFO - 2015-11-24 00:43:50,284 DEBUG : BROWSER_OUTPUT: RSS: Main: 236097536 00:43:50 INFO - 2015-11-24 00:43:50,284 DEBUG : BROWSER_OUTPUT: 00:46:52 INFO - 2015-11-24 00:46:52,815 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/dromaeo/cssquery-ext.html (next: http://localhost:58543/tests/dromaeo/cssquery-jquery.html) 00:46:53 INFO - 2015-11-24 00:46:53,397 DEBUG : BROWSER_OUTPUT: RSS: Main: 213864448 00:46:53 INFO - 2015-11-24 00:46:53,397 DEBUG : BROWSER_OUTPUT: 00:49:55 INFO - 2015-11-24 00:49:55,497 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/dromaeo/cssquery-jquery.html (next: http://localhost:58543/tests/dromaeo/cssquery-mootools.html) 00:49:56 INFO - 2015-11-24 00:49:56,078 DEBUG : BROWSER_OUTPUT: RSS: Main: 211050496 00:49:56 INFO - 2015-11-24 00:49:56,078 DEBUG : BROWSER_OUTPUT: 00:52:57 INFO - 2015-11-24 00:52:57,989 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/dromaeo/cssquery-mootools.html (next: http://localhost:58543/tests/dromaeo/cssquery-prototype.html) 00:52:58 INFO - 2015-11-24 00:52:58,555 DEBUG : BROWSER_OUTPUT: RSS: Main: 196825088 00:52:58 INFO - 2015-11-24 00:52:58,555 DEBUG : BROWSER_OUTPUT: 00:56:01 INFO - 2015-11-24 00:56:01,308 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/dromaeo/cssquery-prototype.html (next: http://localhost:58543/tests/dromaeo/cssquery-yui.html) 00:56:01 INFO - 2015-11-24 00:56:01,910 DEBUG : BROWSER_OUTPUT: RSS: Main: 205103104 00:56:01 INFO - 2015-11-24 00:56:01,910 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,439 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/dromaeo/cssquery-yui.html (next: http://localhost:58543/tests/dromaeo/cssquery-dojo.html) 00:59:04 INFO - 2015-11-24 00:59:04,689 DEBUG : BROWSER_OUTPUT: RSS: Main: 250929152 00:59:04 INFO - 2015-11-24 00:59:04,689 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,689 DEBUG : BROWSER_OUTPUT: __start_tp_report 00:59:04 INFO - 2015-11-24 00:59:04,690 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 00:59:04 INFO - 2015-11-24 00:59:04,690 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 00:59:04 INFO - 2015-11-24 00:59:04,690 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 00:59:04 INFO - 2015-11-24 00:59:04,691 DEBUG : BROWSER_OUTPUT: |0;dojo.html;2598.947426292352;2683.5303821831176;2685.7582817546418;2692.2057992892096;2704.5943108533725;4507.481639611446;4631.189541830179;4665.136949664315;4689.57793798558;4708.434987801465;4618.538146185379;4630.12027714734;4705.082508910764;4719.362886010387;4730.432348118231;4284.892877678059;4315.180115778008;4333.848315308965;4350.80421381037;4394.912101757963;4352.3471479278205;4391.187630288407;4415.183191109639;4420.491643460995;4437.1125774844995;4188.72773269738;4274.7435153890865;4299.419578356944;4392.472903251598;4396.428464299621;4339.175556644227;4348.782560871975;4351.325544540601;4351.825926962918;4379.430674012358;4311.82752689892;4313.870583882457;4316.762578058206;4355.673324500675;4364.650827933758;4405.427294451701;4510.21071312519;4550.908981820378;4563.840265590721;4611.723296602215;5000.67495612784;5041.092603331399;5045.318881950926;5049.368828896388;5095.464976177522;5078.695278283315;5083.161278389061;5084.237364395333;5088.440271570124;5090.872728181788;4555.817767289304;4656.8602941911795;4673.883152921204;4684.039771846729;4768.094062128184;5116.488351164928;5130.486951304914;5137.51193636604;5144.408393034774;5182.896342073137;4933.671187956519;4944.60443164546;4952.777125029383;4953.380827396575;4992;4802.591779698765;4899.2896030075435;4914.189158788831;4914.827981020647;4929.975350123226;5022.949770502249;5023.949760502422;5032.370953630796;5032.421271553818;5041.621878359138;4989.276554899592;4991.301217829507;4992.750362481861;4993.700377977333;5038.748062596929;4015.3374693175297;4170.9582904171175;4201.7268877522865;4208.200441916088;4251.681123915719;3521.9119522012156;3607.0801945503727;3609.097725568608;3609.639036096369;3625.2568223514645;4315.331123675835;4331.177076355482;4335.523092459827;4339.138167031345;4375.01562148514;5049;5054.721990290495;5056.898862022813;5067.4932506749765;5082.415522214993;4166.291730405838;4256.404103425523;4257.254980378421;4258.339957306561;4354.586314300136;4438.201123797748;4481.395011673448;4492.191405547033;4493.326001099861;4533;4802.135615589227;4811.78346974387;4813.350197723263;4819.204831202812;4850.927236091461;4753.572178503813;4849.369581954465;4852.369192005158;4930.161872481615;5056.7724452399;4787.40157480315;4811.4707382188635;4828.734419606955;4829.2997515359375;4872.951270487391;5002.274670172877;5010.073136469765;5020.422651395136;5021.899562008813;5031.195008798574;4739.620830333496;4848.9757551212015;4849.539293767087;4919.311296418433;5049.444561098203;4856.1016212000895;4882.755862206946;4890.168671325812;4891.804327826847;4941.777620007037;4845.961615850483;4873.634477414137;4882.389701287339;4882.462929077869;4930.309756634002;4586.77066146698;4644.767761611974;4677.2750223715375;4679.625629949528;4762.499937506651;4868.586170175575;4912.95087049125;4922.163232250455;4925.21196608541;4926.261060840902;4802.27965805132;4814.566688997867;4814.5907597854575;4816.710997340171;4843.612510999182 00:59:04 INFO - 2015-11-24 00:59:04,695 DEBUG : BROWSER_OUTPUT: |1;ext.html;551.1677367175566;561.6601955816731;561.9522340601048;566.8412844403566;574.5518495573455;27063.188104356876;35806.46290305644;36690;36791;36831.26337473252;38317.80841095791;38824;38899.41650875232;38910.8054459728;38937.805310973476;7041.612711300876;7149.928500714978;7741.806454838617;7907.327877130451;7925.048994120685;9930.404175749441;10051.949740251288;10130.797384052314;10164.237682173829;10169.135623471977;9937.205023598131;10062.19502439803;10075.798484030314;10094.394336339843;10096;7153.928460715404;7329.303716146957;7343.045404097486;9817.558209880572;9861.408315501058;9750.609975601039;9916.752081197956;9917.157041651397;9922.206223502102;9925.90074099257;35432.82283588566;35838;35882;35891.64108358909;35951.101222469384;2585.0952166741677;2705.4183350579524;2755.5040092783292;2951.940961180786;3121.562981182636;26127;26570.46859062808;26634.467310653872;26712.866435667893;26768.732312677013;3298.719608833252;3320.850561724704;3353.765236433451;3375.594928608583;3428.142964258935;214366;216366;216576;216790;216791.91604042036;48073.27890081651;49358.753206234454;53689.46310536923;58980.705096474245;60506.39493605096;53265.73367133139;53376.733116334944;53477.465225347245;53486.465135348924;53618.46381536213;13663.658408539668;13862.653433664038;13862.65343366424;13866.376013079234;13873.58379248624;10542.578296868192;10601.098906593026;10631.787364252827;10633.680989570325;10803.297785643908;18389.90805045966;18604.906975465037;18615.162317695736;18638.720419193724;18660.53348666267;7376.96311518439;7675.462717609714;7685.769426917202;7713.961430192813;7778.611069446505;823.9382046346548;854.5385491834464;866.2982983783156;946.5267366316841;967.8596603492454;29979.400411992076;30944.535831962537;31186.84406577998;31384.37231255362;31712.36575268482;872.7774417523491;894.2130924786146;918.7473444802732;942.6276620734772;970.1850445625709;13026.41381137851;13048.34758262083;13164.275964822027;13181.209127452383;13268.535601254103;328375;334100;334362;336154;336489;44606.55393446024;45228.3215751764;45253;45325.093498129856;45367.31949020767;1033.426448321174;1104.5692180049787;1135.3017893995134;1207.4506099724604;1230.7046308885804;22039.889800550896;22114.88942555277;22603.208887688852;22668.773312266665;22768.316950490847;34947.47578786269;36376.09059773527;36798.44802328021;36861.26277474382;36861.81569092245;192996;323634;333476;333988;334171;27518;27739;28013.719862801925;28015.159545213675;28030.579541306488;36119.45820812637;36263.45604815877;36591.26817463689;36931;36993;29915.102546923627;31475.52786708247;31527.52708709417;32143.839280803448;32533.34933301368;31589.47184242794;32071.839640801645;32580;32664.83667581647;32728.836355818068;32690.50964235586;32836.83581582077;36672;37485;37845.243095138496;28811.5678264822;30216.84891575616;30460.238494037825;30575.96516171343;30674;23536.52926941486;23584.52830943406;23861.642075368538;23995.400114997265;24148.39629009289 00:59:04 INFO - 2015-11-24 00:59:04,695 DEBUG : BROWSER_OUTPUT: |2;jquery.html;332.2192846809998;332.4730302470583;332.96448046575154;332.99500507492394;333.02589924470914;12447.813282800766;12814.743705125915;15278.465253716122;15691.84308156918;15895.125768082751;10047.748806279847;10110.696679099621;10553.155747540197;10555.313904596196;10773.730656733585;4520.254158063924;4655.301704744282;4656.092062047902;4656.837010704626;4658.534146585332;3367.24237046665;3455.602605700339;4682.157211701892;4712.764361781914;5055.721935293557;5183.714895680736;5184.948150518503;5193.246979188016;5206.193040078775;5212.270282160501;5109.591232701394;5228.843134705927;5234.241035049935;5242;5250.842474725745;5041.369828771403;5048.368953880765;5053.69677819332;5058.392992840846;5060.898782024339;11433.542658293742;13596.59210223695;18081.909590452095;18636.068196590117;18689.626207475776;1659.6597697471989;1686.4350442601742;1707.4536148432508;1714.7856517935259;1772.9468115956543;9363.297752668577;9421.293402994803;10013.257972228055;10216.591336346537;12648.810267845989;1641.2040160522138;1659.7178479658487;1663.8336166383265;1687.0805411051006;1754.7104727719911;53042;54384.45615543833;54479;55404;55679.721601391735;8886.644534218689;8967.327450441244;9034.63861445548;9239.429297019522;9374.390664606779;11216.943915280372;11303.773924521463;11304;11306.886931130748;11317.151213659008;6026.337102918676;6088.330283668793;6134.294556126102;6149.13912052313;6171.660558669317;5790.334111577223;5799.101139323411;5811.186433899257;5818.6217895836635;5827.59206855516;3871;3992.960070399317;4028.5568587455355;4031.5565287818317;4125.824140120051;1568.8431156884449;1649.4144578674398;1716.1379902805347;1716.45107016081;1738.452387497934;818.2308629887887;868.2576397180446;882.5454890731279;888.4846788862574;965.5461932891529;14556.199409032393;14602.561923142322;14830.40678372853;15196.240187990556;15247;734.2657342657343;795.7652492514723;839.7186942374251;843.7004863273572;919.4483310013939;8610.268127209258;8734.781630459289;8806.898291752643;8887.11128887119;8909.821803563893;442653;451979;454900;457013.8642374635;477420;68818.65590672115;69416;69440;70238;71093.64453177701;1004.5881188712739;1004.7940172264668;1010.661428421487;1017.1049476460668;1021.6322124035341;13742.106763060368;13781.586552403443;13818.614568354162;13972.79040814409;13984.091034082752;30415.847920760254;30481.847590761903;30952.0714378569;31211.375772484877;31320.53019204668;41773.37339939964;42186.57813421827;42205.36691949562;42735;42839.14321713486;8857.335699822668;9010.819783604422;9084.727458176265;9094.954525227331;9199.218066464426;14816.407343706562;15587.35015047422;16110.355585776437;16383.344666213217;16388.180590970165;12465.252084874937;12826.102172847812;12885.742285154432;13311.201327920357;13579.45682172702;11933.403329833647;12939.870601293867;13119.803202952155;13343.532976345781;13385.464581416634;10287.130555745958;13241.602751917459;14285.64285892861;14500.782488262896;14688.82489400824;8204.097549269694;8232.17678232172;8556.529390883561;8687.565621718762;8715.52064636451;13386.26375549354;13629.727405451637;13647.249401283025;13893.30533473302;13974.930125349309 00:59:04 INFO - 2015-11-24 00:59:04,698 DEBUG : BROWSER_OUTPUT: |3;mootools.html;1164.2490593567145;1590.1572166751623;1626.7153248181564;1635.8936669116506;1663.0936139803814;5847.122931560268;6338.841528961778;6518.967405162967;6522.9021564676505;6524.445422139124;6736.66316684165;6775.525713200078;6793.320667933204;6795.830104247396;6799;1734.1675995522157;1757.411267225481;2049.9077541510633;2073.699313599527;2075.6678931370984;2026.9391918242402;2054.260466232155;2066.917323307066;2069.668852983523;2070.710100585919;1975.5456245063644;2019.1317733374642;2019.6566583680735;2030.5938812237612;2040.3776848061336;1980.3167907072036;2047.37555045711;2082.6771850363066;2086.019570801728;2086.040421406155;2064.886431246281;2094.1623350659856;2094.9266775662777;2096.706461095448;2098.569793192392;6534;6625;6630.403263706241;6634.170728658918;6638.20341559016;3956.4460975463458;3976.602339766029;3976.9005774855573;4012.177503611782;4013.0769922917602;2575.5364034473787;2696.4876673431986;2700.3249187703072;2715.7691596214345;2719.265798234466;757.8446418484252;857.5112186053951;862.1292494580456;865.7878819689154;887.0685779931047;8760.649574017032;8915.108489151098;8917.197452229266;8923.286137109015;8937.865932011026;3648.3980143276594;3669;3731.6081811409413;3752.9061773455337;3761.3793724035227;7495.8500829983095;7496.100467943882;7509;7525.924740752523;7534.171241163468;4115.526714427879;4132.421460995463;4134.937975930364;4141.482314710661;4143.751374917515;3821.7197238925273;3823.617638236154;3823.866164684223;3824.6749026333073;3827.73205875586;3046.84765761711;3054.4043911437057;3058.2660161561066;3090;3093.443180227581;903.9050899655573;907.2243232036645;912.7991841794794;914.5518695839124;915.2449229385784;1060.3319908457777;1077;1115.297362661518;1131.7396998690347;1132.7281452451352;6535.248446428626;6536.575122617015;6550.312217217123;6553.2136143663065;6563.113979612786;428.6463667474284;441.9381286619876;442.6879050269552;443.60740744441404;456.5571395746121;5020.849374518771;5032.748362581856;5059.46875578059;5069.594432445396;5071.163258062378;8030.39772017101;8095.069067057246;8133.146019667968;8160.83678326442;8229.711960081368;7982.880256796153;8026.678932842738;8034.116247212802;8034.718784842503;8060.879086813702;6250.124982502453;6370.331115232834;6388.808335749842;6399.488040956712;6433.967830160819;6225.190725205875;6246.593971391845;6246.750129994749;6252.062190671254;6259.311475737574;7155.819289817122;7351.926480735338;7367.447441441806;7385.224551422023;7420.03539539878;7388.704451821867;7498;7537.057867766529;7543.283388078124;7546.3962882968135;5522.337319521683;5567.387587365306;5570.442955704397;5580.497755202051;5581.6930068846605;6321.367863213642;6329.810105696836;6346.714397852015;6370.331115232834;6378.585391949508;5748.971255143698;5788.044972579477;6051.697415129314;6053.061775424816;6266.561340706106;6013.879722405615;6037.154798328325;6044.516438684983;6097.054956481752;6104.20645316106;6172.351903050115;6205;6206;6220.098085777628;6224.595401298901;5696.686682232517;5767.048437007847;5774.451427114417;5778.046622307273;5780.971095144498;5141.948580514297;5882.852928676817;5924.940750592439;5929.644221346733;5942.168096466585 00:59:04 INFO - 2015-11-24 00:59:04,700 DEBUG : BROWSER_OUTPUT: |4;prototype.html;307.5893681934617;312.3923967882468;313.1466753097809;319.39952888569485;321.18259030766694;5226.18994055921;5359.410464848873;5384.40771515133;5400.486953739398;5406.486383793538;5136.794528218876;5307.416184219733;5307.469253074691;5326.360836699591;5336.546393556552;4211.747295162285;4228.72513286637;4233.407322974786;4235.491740991078;4243.830246790125;3988.880333589997;4056.249593825152;4061.87814365568;4063.918721625566;4227.429297044906;4031.2340655275552;4034.6570541504007;4048.5951404859575;4135.669146468275;4137.855175068873;4173.3114036184;4178.310578754502;4188.68584856137;4190.727602705814;4197.580241975808;3708.627807711164;3710.7959062251566;3711.554613446404;3713.6843368313725;3715.8142092895246;5053.84838454847;5166.715830629351;5167.457416971239;5169.741512924339;5171.689698618095;4810.807567697288;4813.302071199656;4816.470188279286;4816.807327706888;4819.44576373718;5598.580106491989;5599.076152434844;5604;5605.887882242332;5606.327240731139;3820.7134464914966;3931.390634451636;3935.1932853765197;4023.758574485511;4057.4116753070934;5878.088896221093;5901.527877769769;5902.1146827976145;5913.586048976574;5920.644761314292;4183.891268813767;4184.66522678185;4185.016521117535;4185.058361868616;4188.204241194163;4217.0511634881905;4248.1078973415315;4249.617534421855;4253.170631726845;4255.021345090647;4674.485806561275;4771.308160316735;4786.44955830077;4786.617070634341;4786.95213047872;5624.85937851557;5627.8593035174445;5632.2678051853;5641.492265696107;5641.689707066151;1488.8660020597981;1512.5462361291789;1512.6520900193018;1512.9697406051816;1515.0758037597057;1023.8976102389702;1035.7410647338165;1045.0751085289573;1047.1361127070197;1048.5596049659162;4948.0103979204305;4955.008998200375;4957.553820156203;4957.826476073392;4960.875978100504;5852;5852.94147058524;5854;5858.2677165354335;5859.2090067841145;4955.90088198234;4957.4794646561595;4958.281049247911;4963.329950456642;4963.875903102379;3093.566900633913;3129.2489802447703;3139.372125574894;3163.6994485523837;3164.936701265962;5515.841673248663;5520.91718624221;5526.281583394133;5526.557875369961;5533.6403133796175;5983.1623572699855;5993.220881285492;5994.310654274727;5996.5202783777195;6004.189434426384;5521.309836270466;5523.447655234525;5529.917051244234;5530.059889818741;5533;5640.689762062962;5845.970770146122;5851.502622277154;5852.619579727304;5854.092615644582;5533.6403133796175;5620.241267428844;5663.235463212413;5698.487136157766;5709.115087161496;5550.8057217997175;5567.164925261243;5570.2480165177185;5571.969185700658;5572.387037425961;4210.221109094828;4210.9789451053775;4211.220924129046;4217.325227963511;4221.134667393116;5867.706614669164;5874.089516125007;5874.559408044328;5877.059670452707;5883.705814709333;5530.944690553043;5686.147077938177;5693.231413759255;5698.715064246854;5698.971505142447;5688.744006519633;5693.800716974886;5696.259486266925;5699.088145896637;5703.857403564944;5566.192902029102;5572.498475137257;5579.16312553104;5579.637323573955;5586.720663966867;5564.387917329172;5717.028105222205;5728.255326807488;5728.513076388554;5736.942630573641;5548.9722551386985;5591.329040515164;5593.972030139823;5594.944050559442;5606.6916319602815 00:59:04 INFO - 2015-11-24 00:59:04,701 DEBUG : BROWSER_OUTPUT: |5;yui.html;606.5336601323436;647.876903388356;759.4000739415861;771.9382449404048;785.1559573458534;10807.891921080796;10976.12191024718;11013.669589912295;11016.11871050314;11029.338239705623;10981.286216395929;11068;11068.723281917955;11073.003429691325;11077.335359878412;587.0841487279846;597.8565144365365;599.7181324777348;599.8470390050531;599.9940000600004;604.8760004199129;735.8712225360567;748.8577170337645;748.988765168523;749.8987636669061;763.152900280688;768.9115751688571;775.9301662850371;777.0946846923356;777.3858651665178;767.6660652616102;772.2624893226955;772.9884051739228;773.3619763694974;773.7910764093691;464.865189095162;572.4590262202221;573.1088157914442;573.2576313673761;573.9713014349265;8913.955430222808;11060.059894908942;11452.427378631035;11456.599019034295;11461.713457163554;11024.944875275653;11132.833007504894;11486;11941.223820451643;12209.633710988595;9363.625454981793;9368.34421590489;9429.057094290585;9471.621135154655;9480.810383792354;3221.7905836120576;3262.771605987582;3266.8856590019473;3300.7359411247044;3318.8340582970995;41229.38155927663;41263.793681031704;41372.79313603443;41546.58453415457;42200;9028.18746312835;9262.490563018964;9681.70954871355;9840.852387214198;9858.901410985798;16982.23579938906;16982.320707171573;17059.573510662332;17060.146992650567;17073.231704573074;6225.595336303126;6312.431881130628;6319.936800631935;6367.299597044322;6617.007448882706;3458.066322093021;3477.965220347764;3498.9125271868406;3517.6834084931966;3530.435130379178;2658.082961378321;2668.159529748123;2671.82633128846;2689.838609683386;2691.811573189858;464.1737706881756;470.5694289724932;475.5648581547845;478.44739326078434;479.1136397664363;451.8825105472601;472.510951165542;516.339085969959;543.9292891924025;585.3648791061661;6555;7059.541129826544;7235.095613048369;7646.770596882103;7894.960525197452;482.6331987689311;485.2333313364875;486.4017258771731;560.7784924954701;608.412881569279;3044.1932887784756;3247.7270365109134;3281.1633033576763;3304.8512816923294;3378.5607870976614;46428.767856160506;46662.76668616635;46747.29879051817;47010;47048.2942755859;41111;41307;42330.365044524355;42341.15317693629;45576.3163552547;37173.065109798226;37254.441183382274;37525.81237093797;41481;43014.569854301684;7317.268273172853;7550.395968322631;7728.661945583302;7801.570913599807;8041;30626;30897;31581.526277105404;31622.367552649277;31674.36651267008;38426.42360364541;38564.6143538561;40673.79663101665;42061.36907946444;42348.5765142357;9276.397034192756;9429.858552121861;9503.61985520599;9574.56914438838;9601.47191904452;9817.65638202688;10027.247956403446;10321.845172322572;10443.164546836388;10558.472076396303;9505.524723763645;9513.66702165421;9604.66383676568;9630.662926797528;9947.751306217402;10030.448325341884;10043.447610381207;10060.39637621745;10064.132224826115;10069.200181606739;9653.372530785477;9682.27382946296;9717.076877696607;9719;9728.221742260745;8322.417430779788;8545.74362769118;8565.050735049224;8865.601047952729;8985.910140898508;8548.529830859363;8731.738047858575;8902.777430564029;8910.153535414125;9118.133777291147 00:59:04 INFO - 2015-11-24 00:59:04,701 DEBUG : BROWSER_OUTPUT: __end_tp_report 00:59:04 INFO - 2015-11-24 00:59:04,701 DEBUG : BROWSER_OUTPUT: __start_cc_report 00:59:04 INFO - 2015-11-24 00:59:04,701 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,904 00:59:04 INFO - 2015-11-24 00:59:04,702 DEBUG : BROWSER_OUTPUT: __end_cc_report 00:59:04 INFO - 2015-11-24 00:59:04,702 DEBUG : BROWSER_OUTPUT: __startTimestamp1448355544688__endTimestamp 00:59:04 INFO - 2015-11-24 00:59:04,702 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,702 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 00:59:04 INFO - 2015-11-24 00:59:04,702 DEBUG : BROWSER_OUTPUT: Number of tests: 6 00:59:04 INFO - 2015-11-24 00:59:04,702 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,702 DEBUG : BROWSER_OUTPUT: [#0] dojo.html Cycles:165 Average:4624.21 Median:4787.40 stddev:486.15 (10.2%) stddev-sans-first:460.95 00:59:04 INFO - 2015-11-24 00:59:04,704 DEBUG : BROWSER_OUTPUT: Values: 2598.9 2683.5 2685.8 2692.2 2704.6 4507.5 4631.2 4665.1 4689.6 4708.4 4618.5 4630.1 4705.1 4719.4 4730.4 4284.9 4315.2 4333.8 4350.8 4394.9 4352.3 4391.2 4415.2 4420.5 4437.1 4188.7 4274.7 4299.4 4392.5 4396.4 4339.2 4348.8 4351.3 4351.8 4379.4 4311.8 4313.9 4316.8 4355.7 4364.7 4405.4 4510.2 4550.9 4563.8 4611.7 5000.7 5041.1 5045.3 5049.4 5095.5 5078.7 5083.2 5084.2 5088.4 5090.9 4555.8 4656.9 4673.9 4684.0 4768.1 5116.5 5130.5 5137.5 5144.4 5182.9 4933.7 4944.6 4952.8 4953.4 4992.0 4802.6 4899.3 4914.2 4914.8 4930.0 5022.9 5023.9 5032.4 5032.4 5041.6 4989.3 4991.3 4992.8 4993.7 5038.7 4015.3 4171.0 4201.7 4208.2 4251.7 3521.9 3607.1 3609.1 3609.6 3625.3 4315.3 4331.2 4335.5 4339.1 4375.0 5049.0 5054.7 5056.9 5067.5 5082.4 4166.3 4256.4 4257.3 4258.3 4354.6 4438.2 4481.4 4492.2 4493.3 4533.0 4802.1 4811.8 4813.4 4819.2 4850.9 4753.6 4849.4 4852.4 4930.2 5056.8 4787.4 4811.5 4828.7 4829.3 4873.0 5002.3 5010.1 5020.4 5021.9 5031.2 4739.6 4849.0 4849.5 4919.3 5049.4 4856.1 4882.8 4890.2 4891.8 4941.8 4846.0 4873.6 4882.4 4882.5 4930.3 4586.8 4644.8 4677.3 4679.6 4762.5 4868.6 4913.0 4922.2 4925.2 4926.3 4802.3 4814.6 4814.6 4816.7 4843.6 00:59:04 INFO - 2015-11-24 00:59:04,704 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,704 DEBUG : BROWSER_OUTPUT: [#1] ext.html Cycles:180 Average:43590.47 Median:168398.43 stddev:76348.29 (45.3%) stddev-sans-first:76494.07 00:59:04 INFO - 2015-11-24 00:59:04,704 DEBUG : BROWSER_OUTPUT: Values: 551.2 561.7 562.0 566.8 574.6 27063.2 35806.5 36690.0 36791.0 36831.3 38317.8 38824.0 38899.4 38910.8 38937.8 7041.6 7149.9 7741.8 7907.3 7925.0 9930.4 10051.9 10130.8 10164.2 10169.1 9937.2 10062.2 10075.8 10094.4 10096.0 7153.9 7329.3 7343.0 9817.6 9861.4 9750.6 9916.8 9917.2 9922.2 9925.9 35432.8 35838.0 35882.0 35891.6 35951.1 2585.1 2705.4 2755.5 2951.9 3121.6 26127.0 26570.5 26634.5 26712.9 26768.7 3298.7 3320.9 3353.8 3375.6 3428.1 214366.0 216366.0 216576.0 216790.0 216791.9 48073.3 49358.8 53689.5 58980.7 60506.4 53265.7 53376.7 53477.5 53486.5 53618.5 13663.7 13862.7 13862.7 13866.4 13873.6 10542.6 10601.1 10631.8 10633.7 10803.3 18389.9 18604.9 18615.2 18638.7 18660.5 7377.0 7675.5 7685.8 7714.0 7778.6 823.9 854.5 866.3 946.5 967.9 29979.4 30944.5 31186.8 31384.4 31712.4 872.8 894.2 918.7 942.6 970.2 13026.4 13048.3 13164.3 13181.2 13268.5 328375.0 334100.0 334362.0 336154.0 336489.0 44606.6 45228.3 45253.0 45325.1 45367.3 1033.4 1104.6 1135.3 1207.5 1230.7 22039.9 22114.9 22603.2 22668.8 22768.3 34947.5 36376.1 36798.4 36861.3 36861.8 192996.0 323634.0 333476.0 333988.0 334171.0 27518.0 27739.0 28013.7 28015.2 28030.6 36119.5 36263.5 36591.3 36931.0 36993.0 29915.1 31475.5 31527.5 32143.8 32533.3 31589.5 32071.8 32580.0 32664.8 32728.8 32690.5 32836.8 36672.0 37485.0 37845.2 28811.6 30216.8 30460.2 30576.0 30674.0 23536.5 23584.5 23861.6 23995.4 24148.4 00:59:04 INFO - 2015-11-24 00:59:04,704 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,704 DEBUG : BROWSER_OUTPUT: [#2] jquery.html Cycles:180 Average:24956.94 Median:3931.98 stddev:74686.85 (1899.5%) stddev-sans-first:74873.48 00:59:04 INFO - 2015-11-24 00:59:04,705 DEBUG : BROWSER_OUTPUT: Values: 332.2 332.5 333.0 333.0 333.0 12447.8 12814.7 15278.5 15691.8 15895.1 10047.7 10110.7 10553.2 10555.3 10773.7 4520.3 4655.3 4656.1 4656.8 4658.5 3367.2 3455.6 4682.2 4712.8 5055.7 5183.7 5184.9 5193.2 5206.2 5212.3 5109.6 5228.8 5234.2 5242.0 5250.8 5041.4 5048.4 5053.7 5058.4 5060.9 11433.5 13596.6 18081.9 18636.1 18689.6 1659.7 1686.4 1707.5 1714.8 1772.9 9363.3 9421.3 10013.3 10216.6 12648.8 1641.2 1659.7 1663.8 1687.1 1754.7 53042.0 54384.5 54479.0 55404.0 55679.7 8886.6 8967.3 9034.6 9239.4 9374.4 11216.9 11303.8 11304.0 11306.9 11317.2 6026.3 6088.3 6134.3 6149.1 6171.7 5790.3 5799.1 5811.2 5818.6 5827.6 3871.0 3993.0 4028.6 4031.6 4125.8 1568.8 1649.4 1716.1 1716.5 1738.5 818.2 868.3 882.5 888.5 965.5 14556.2 14602.6 14830.4 15196.2 15247.0 734.3 795.8 839.7 843.7 919.4 8610.3 8734.8 8806.9 8887.1 8909.8 442653.0 451979.0 454900.0 457013.9 477420.0 68818.7 69416.0 69440.0 70238.0 71093.6 1004.6 1004.8 1010.7 1017.1 1021.6 13742.1 13781.6 13818.6 13972.8 13984.1 30415.8 30481.8 30952.1 31211.4 31320.5 41773.4 42186.6 42205.4 42735.0 42839.1 8857.3 9010.8 9084.7 9095.0 9199.2 14816.4 15587.4 16110.4 16383.3 16388.2 12465.3 12826.1 12885.7 13311.2 13579.5 11933.4 12939.9 13119.8 13343.5 13385.5 10287.1 13241.6 14285.6 14500.8 14688.8 8204.1 8232.2 8556.5 8687.6 8715.5 13386.3 13629.7 13647.2 13893.3 13974.9 00:59:04 INFO - 2015-11-24 00:59:04,706 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,706 DEBUG : BROWSER_OUTPUT: [#3] mootools.html Cycles:180 Average:4706.82 Median:5927.29 stddev:2419.16 (40.8%) stddev-sans-first:2411.29 00:59:04 INFO - 2015-11-24 00:59:04,706 DEBUG : BROWSER_OUTPUT: Values: 1164.2 1590.2 1626.7 1635.9 1663.1 5847.1 6338.8 6519.0 6522.9 6524.4 6736.7 6775.5 6793.3 6795.8 6799.0 1734.2 1757.4 2049.9 2073.7 2075.7 2026.9 2054.3 2066.9 2069.7 2070.7 1975.5 2019.1 2019.7 2030.6 2040.4 1980.3 2047.4 2082.7 2086.0 2086.0 2064.9 2094.2 2094.9 2096.7 2098.6 6534.0 6625.0 6630.4 6634.2 6638.2 3956.4 3976.6 3976.9 4012.2 4013.1 2575.5 2696.5 2700.3 2715.8 2719.3 757.8 857.5 862.1 865.8 887.1 8760.6 8915.1 8917.2 8923.3 8937.9 3648.4 3669.0 3731.6 3752.9 3761.4 7495.9 7496.1 7509.0 7525.9 7534.2 4115.5 4132.4 4134.9 4141.5 4143.8 3821.7 3823.6 3823.9 3824.7 3827.7 3046.8 3054.4 3058.3 3090.0 3093.4 903.9 907.2 912.8 914.6 915.2 1060.3 1077.0 1115.3 1131.7 1132.7 6535.2 6536.6 6550.3 6553.2 6563.1 428.6 441.9 442.7 443.6 456.6 5020.8 5032.7 5059.5 5069.6 5071.2 8030.4 8095.1 8133.1 8160.8 8229.7 7982.9 8026.7 8034.1 8034.7 8060.9 6250.1 6370.3 6388.8 6399.5 6434.0 6225.2 6246.6 6246.8 6252.1 6259.3 7155.8 7351.9 7367.4 7385.2 7420.0 7388.7 7498.0 7537.1 7543.3 7546.4 5522.3 5567.4 5570.4 5580.5 5581.7 6321.4 6329.8 6346.7 6370.3 6378.6 5749.0 5788.0 6051.7 6053.1 6266.6 6013.9 6037.2 6044.5 6097.1 6104.2 6172.4 6205.0 6206.0 6220.1 6224.6 5696.7 5767.0 5774.5 5778.0 5781.0 5141.9 5882.9 5924.9 5929.6 5942.2 00:59:04 INFO - 2015-11-24 00:59:04,706 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,706 DEBUG : BROWSER_OUTPUT: [#4] prototype.html Cycles:180 Average:4703.21 Median:5198.94 stddev:1359.28 (26.1%) stddev-sans-first:1322.45 00:59:04 INFO - 2015-11-24 00:59:04,707 DEBUG : BROWSER_OUTPUT: Values: 307.6 312.4 313.1 319.4 321.2 5226.2 5359.4 5384.4 5400.5 5406.5 5136.8 5307.4 5307.5 5326.4 5336.5 4211.7 4228.7 4233.4 4235.5 4243.8 3988.9 4056.2 4061.9 4063.9 4227.4 4031.2 4034.7 4048.6 4135.7 4137.9 4173.3 4178.3 4188.7 4190.7 4197.6 3708.6 3710.8 3711.6 3713.7 3715.8 5053.8 5166.7 5167.5 5169.7 5171.7 4810.8 4813.3 4816.5 4816.8 4819.4 5598.6 5599.1 5604.0 5605.9 5606.3 3820.7 3931.4 3935.2 4023.8 4057.4 5878.1 5901.5 5902.1 5913.6 5920.6 4183.9 4184.7 4185.0 4185.1 4188.2 4217.1 4248.1 4249.6 4253.2 4255.0 4674.5 4771.3 4786.4 4786.6 4787.0 5624.9 5627.9 5632.3 5641.5 5641.7 1488.9 1512.5 1512.7 1513.0 1515.1 1023.9 1035.7 1045.1 1047.1 1048.6 4948.0 4955.0 4957.6 4957.8 4960.9 5852.0 5852.9 5854.0 5858.3 5859.2 4955.9 4957.5 4958.3 4963.3 4963.9 3093.6 3129.2 3139.4 3163.7 3164.9 5515.8 5520.9 5526.3 5526.6 5533.6 5983.2 5993.2 5994.3 5996.5 6004.2 5521.3 5523.4 5529.9 5530.1 5533.0 5640.7 5846.0 5851.5 5852.6 5854.1 5533.6 5620.2 5663.2 5698.5 5709.1 5550.8 5567.2 5570.2 5572.0 5572.4 4210.2 4211.0 4211.2 4217.3 4221.1 5867.7 5874.1 5874.6 5877.1 5883.7 5530.9 5686.1 5693.2 5698.7 5699.0 5688.7 5693.8 5696.3 5699.1 5703.9 5566.2 5572.5 5579.2 5579.6 5586.7 5564.4 5717.0 5728.3 5728.5 5736.9 5549.0 5591.3 5594.0 5594.9 5606.7 00:59:04 INFO - 2015-11-24 00:59:04,708 DEBUG : BROWSER_OUTPUT: 00:59:04 INFO - 2015-11-24 00:59:04,708 DEBUG : BROWSER_OUTPUT: [#5] yui.html Cycles:180 Average:11903.68 Median:480.87 stddev:13563.70 (2820.6%) stddev-sans-first:13575.22 00:59:04 INFO - 2015-11-24 00:59:04,708 DEBUG : BROWSER_OUTPUT: Values: 606.5 647.9 759.4 771.9 785.2 10807.9 10976.1 11013.7 11016.1 11029.3 10981.3 11068.0 11068.7 11073.0 11077.3 587.1 597.9 599.7 599.8 600.0 604.9 735.9 748.9 749.0 749.9 763.2 768.9 775.9 777.1 777.4 767.7 772.3 773.0 773.4 773.8 464.9 572.5 573.1 573.3 574.0 8914.0 11060.1 11452.4 11456.6 11461.7 11024.9 11132.8 11486.0 11941.2 12209.6 9363.6 9368.3 9429.1 9471.6 9480.8 3221.8 3262.8 3266.9 3300.7 3318.8 41229.4 41263.8 41372.8 41546.6 42200.0 9028.2 9262.5 9681.7 9840.9 9858.9 16982.2 16982.3 17059.6 17060.1 17073.2 6225.6 6312.4 6319.9 6367.3 6617.0 3458.1 3478.0 3498.9 3517.7 3530.4 2658.1 2668.2 2671.8 2689.8 2691.8 464.2 470.6 475.6 478.4 479.1 451.9 472.5 516.3 543.9 585.4 6555.0 7059.5 7235.1 7646.8 7895.0 482.6 485.2 486.4 560.8 608.4 3044.2 3247.7 3281.2 3304.9 3378.6 46428.8 46662.8 46747.3 47010.0 47048.3 41111.0 41307.0 42330.4 42341.2 45576.3 37173.1 37254.4 37525.8 41481.0 43014.6 7317.3 7550.4 7728.7 7801.6 8041.0 30626.0 30897.0 31581.5 31622.4 31674.4 38426.4 38564.6 40673.8 42061.4 42348.6 9276.4 9429.9 9503.6 9574.6 9601.5 9817.7 10027.2 10321.8 10443.2 10558.5 9505.5 9513.7 9604.7 9630.7 9947.8 10030.4 10043.4 10060.4 10064.1 10069.2 9653.4 9682.3 9717.1 9719.0 9728.2 8322.4 8545.7 8565.1 8865.6 8985.9 8548.5 8731.7 8902.8 8910.2 9118.1 00:59:04 INFO - 2015-11-24 00:59:04,708 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 00:59:04 INFO - 2015-11-24 00:59:04,708 DEBUG : BROWSER_OUTPUT: 00:59:05 INFO - 2015-11-24 00:59:05,386 INFO : Browser exited with error code: 0 00:59:05 INFO - 2015-11-24 00:59:05,404 INFO : Completed test dromaeo_css (00:18:37) 00:59:05 INFO - 2015-11-24 00:59:05,404 INFO : Starting test kraken 00:59:05 INFO - 2015-11-24 00:59:05,405 DEBUG : operating with platform_type : linux_ 00:59:05 INFO - 2015-11-24 00:59:05,405 INFO : Initialising browser for kraken test... 00:59:05 INFO - 2015-11-24 00:59:05,411 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHVwq5Q/profile http://localhost:58543/getInfo.html 00:59:09 INFO - 2015-11-24 00:59:09,621 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 00:59:09 INFO - 2015-11-24 00:59:09,621 DEBUG : BROWSER_OUTPUT: colorDepth:24 00:59:09 INFO - 2015-11-24 00:59:09,621 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 00:59:09 INFO - 2015-11-24 00:59:09,621 DEBUG : BROWSER_OUTPUT: __metrics 00:59:09 INFO - 2015-11-24 00:59:09,783 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 00:59:11 INFO - 2015-11-24 00:59:11,081 INFO : Browser initialized. 00:59:11 INFO - 2015-11-24 00:59:11,081 INFO : Running cycle 1/1 for kraken test... 00:59:11 INFO - 2015-11-24 00:59:11,082 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHVwq5Q/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 00:59:23 INFO - 2015-11-24 00:59:23,037 DEBUG : BROWSER_OUTPUT: RSS: Main: 140189696 00:59:23 INFO - 2015-11-24 00:59:23,037 DEBUG : BROWSER_OUTPUT: 00:59:25 INFO - 2015-11-24 00:59:25,644 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:58543/tests/kraken/driver.html?testName=audio-beat-detection) 00:59:26 INFO - 2015-11-24 00:59:26,230 DEBUG : BROWSER_OUTPUT: RSS: Main: 177102848 00:59:26 INFO - 2015-11-24 00:59:26,230 DEBUG : BROWSER_OUTPUT: 00:59:28 INFO - 2015-11-24 00:59:28,931 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:58543/tests/kraken/driver.html?testName=audio-dft) 00:59:29 INFO - 2015-11-24 00:59:29,513 DEBUG : BROWSER_OUTPUT: RSS: Main: 167321600 00:59:29 INFO - 2015-11-24 00:59:29,513 DEBUG : BROWSER_OUTPUT: 00:59:32 INFO - 2015-11-24 00:59:32,516 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:58543/tests/kraken/driver.html?testName=audio-fft) 00:59:33 INFO - 2015-11-24 00:59:33,083 DEBUG : BROWSER_OUTPUT: RSS: Main: 152776704 00:59:33 INFO - 2015-11-24 00:59:33,084 DEBUG : BROWSER_OUTPUT: 00:59:35 INFO - 2015-11-24 00:59:35,121 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:58543/tests/kraken/driver.html?testName=audio-oscillator) 00:59:35 INFO - 2015-11-24 00:59:35,694 DEBUG : BROWSER_OUTPUT: RSS: Main: 154992640 00:59:35 INFO - 2015-11-24 00:59:35,695 DEBUG : BROWSER_OUTPUT: 00:59:37 INFO - 2015-11-24 00:59:37,954 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:58543/tests/kraken/driver.html?testName=imaging-gaussian-blur) 00:59:38 INFO - 2015-11-24 00:59:38,526 DEBUG : BROWSER_OUTPUT: RSS: Main: 155328512 00:59:38 INFO - 2015-11-24 00:59:38,527 DEBUG : BROWSER_OUTPUT: 00:59:41 INFO - 2015-11-24 00:59:41,484 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:58543/tests/kraken/driver.html?testName=imaging-darkroom) 00:59:42 INFO - 2015-11-24 00:59:42,066 DEBUG : BROWSER_OUTPUT: RSS: Main: 156540928 00:59:42 INFO - 2015-11-24 00:59:42,066 DEBUG : BROWSER_OUTPUT: 00:59:45 INFO - 2015-11-24 00:59:45,462 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:58543/tests/kraken/driver.html?testName=imaging-desaturate) 00:59:46 INFO - 2015-11-24 00:59:46,035 DEBUG : BROWSER_OUTPUT: RSS: Main: 157405184 00:59:46 INFO - 2015-11-24 00:59:46,035 DEBUG : BROWSER_OUTPUT: 00:59:48 INFO - 2015-11-24 00:59:48,857 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:58543/tests/kraken/driver.html?testName=json-parse-financial) 00:59:49 INFO - 2015-11-24 00:59:49,439 DEBUG : BROWSER_OUTPUT: RSS: Main: 156454912 00:59:49 INFO - 2015-11-24 00:59:49,439 DEBUG : BROWSER_OUTPUT: 00:59:51 INFO - 2015-11-24 00:59:51,188 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:58543/tests/kraken/driver.html?testName=json-stringify-tinderbox) 00:59:51 INFO - 2015-11-24 00:59:51,749 DEBUG : BROWSER_OUTPUT: RSS: Main: 165109760 00:59:51 INFO - 2015-11-24 00:59:51,749 DEBUG : BROWSER_OUTPUT: 00:59:53 INFO - 2015-11-24 00:59:53,641 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-aes) 00:59:54 INFO - 2015-11-24 00:59:54,243 DEBUG : BROWSER_OUTPUT: RSS: Main: 166326272 00:59:54 INFO - 2015-11-24 00:59:54,243 DEBUG : BROWSER_OUTPUT: 00:59:56 INFO - 2015-11-24 00:59:56,381 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-ccm) 00:59:56 INFO - 2015-11-24 00:59:56,962 DEBUG : BROWSER_OUTPUT: RSS: Main: 169906176 00:59:56 INFO - 2015-11-24 00:59:56,962 DEBUG : BROWSER_OUTPUT: 00:59:59 INFO - 2015-11-24 00:59:59,497 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 01:00:00 INFO - 2015-11-24 01:00:00,078 DEBUG : BROWSER_OUTPUT: RSS: Main: 180277248 01:00:00 INFO - 2015-11-24 01:00:00,078 DEBUG : BROWSER_OUTPUT: 01:00:02 INFO - 2015-11-24 01:00:02,653 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 01:00:03 INFO - 2015-11-24 01:00:03,226 DEBUG : BROWSER_OUTPUT: RSS: Main: 180494336 01:00:03 INFO - 2015-11-24 01:00:03,226 DEBUG : BROWSER_OUTPUT: 01:00:04 INFO - 2015-11-24 01:00:04,995 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:58543/tests/kraken/driver.html?testName=ai-astar) 01:00:05 INFO - 2015-11-24 01:00:05,239 DEBUG : BROWSER_OUTPUT: RSS: Main: 240955392 01:00:05 INFO - 2015-11-24 01:00:05,239 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,242 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:00:05 INFO - 2015-11-24 01:00:05,243 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:00:05 INFO - 2015-11-24 01:00:05,243 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:00:05 INFO - 2015-11-24 01:00:05,243 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:00:05 INFO - 2015-11-24 01:00:05,243 DEBUG : BROWSER_OUTPUT: |0;ai-astar;111;114;106;112;113;113;102;114;113;106 01:00:05 INFO - 2015-11-24 01:00:05,243 DEBUG : BROWSER_OUTPUT: |1;audio-beat-detection;155;129;151;164;134;157;160;130;174;130 01:00:05 INFO - 2015-11-24 01:00:05,243 DEBUG : BROWSER_OUTPUT: |2;audio-dft;161;162;160;160;160;161;164;162;163;164 01:00:05 INFO - 2015-11-24 01:00:05,243 DEBUG : BROWSER_OUTPUT: |3;audio-fft;72;72;83;96;74;73;75;119;89;73 01:00:05 INFO - 2015-11-24 01:00:05,244 DEBUG : BROWSER_OUTPUT: |4;audio-oscillator;95;95;128;95;94;95;132;94;94;134 01:00:05 INFO - 2015-11-24 01:00:05,244 DEBUG : BROWSER_OUTPUT: |5;imaging-gaussian-blur;109;110;109;109;109;109;110;109;109;109 01:00:05 INFO - 2015-11-24 01:00:05,244 DEBUG : BROWSER_OUTPUT: |6;imaging-darkroom;146;148;146;148;147;147;147;148;147;148 01:00:05 INFO - 2015-11-24 01:00:05,244 DEBUG : BROWSER_OUTPUT: |7;imaging-desaturate;96;96;96;95;95;95;95;95;95;95 01:00:05 INFO - 2015-11-24 01:00:05,244 DEBUG : BROWSER_OUTPUT: |8;json-parse-financial;70;71;71;71;72;70;72;79;68;68 01:00:05 INFO - 2015-11-24 01:00:05,244 DEBUG : BROWSER_OUTPUT: |9;json-stringify-tinderbox;68;70;69;69;70;69;68;69;69;68 01:00:05 INFO - 2015-11-24 01:00:05,244 DEBUG : BROWSER_OUTPUT: |10;stanford-crypto-aes;90;82;84;83;84;84;82;82;84;88 01:00:05 INFO - 2015-11-24 01:00:05,245 DEBUG : BROWSER_OUTPUT: |11;stanford-crypto-ccm;123;123;123;129;126;123;128;118;121;119 01:00:05 INFO - 2015-11-24 01:00:05,245 DEBUG : BROWSER_OUTPUT: |12;stanford-crypto-pbkdf2;148;136;150;138;145;137;148;145;154;135 01:00:05 INFO - 2015-11-24 01:00:05,245 DEBUG : BROWSER_OUTPUT: |13;stanford-crypto-sha256-iterative;68;69;67;70;68;68;70;68;69;68 01:00:05 INFO - 2015-11-24 01:00:05,245 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:00:05 INFO - 2015-11-24 01:00:05,245 DEBUG : BROWSER_OUTPUT: __start_cc_report 01:00:05 INFO - 2015-11-24 01:00:05,245 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_cycle_collect,978 01:00:05 INFO - 2015-11-24 01:00:05,245 DEBUG : BROWSER_OUTPUT: __end_cc_report 01:00:05 INFO - 2015-11-24 01:00:05,246 DEBUG : BROWSER_OUTPUT: __startTimestamp1448355605241__endTimestamp 01:00:05 INFO - 2015-11-24 01:00:05,246 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,253 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:00:05 INFO - 2015-11-24 01:00:05,253 DEBUG : BROWSER_OUTPUT: Number of tests: 14 01:00:05 INFO - 2015-11-24 01:00:05,253 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,253 DEBUG : BROWSER_OUTPUT: [#0] ai-astar Cycles:10 Average:110.40 Median:113.00 stddev:4.20 (3.7%) stddev-sans-first:4.44 01:00:05 INFO - 2015-11-24 01:00:05,253 DEBUG : BROWSER_OUTPUT: Values: 111.0 114.0 106.0 112.0 113.0 113.0 102.0 114.0 113.0 106.0 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: [#1] audio-beat-detection Cycles:10 Average:148.40 Median:156.00 stddev:16.39 (10.5%) stddev-sans-first:17.21 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: Values: 155.0 129.0 151.0 164.0 134.0 157.0 160.0 130.0 174.0 130.0 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: [#2] audio-dft Cycles:10 Average:161.70 Median:162.00 stddev:1.57 (1.0%) stddev-sans-first:1.64 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: Values: 161.0 162.0 160.0 160.0 160.0 161.0 164.0 162.0 163.0 164.0 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: [#3] audio-fft Cycles:10 Average:82.60 Median:74.50 stddev:15.23 (20.4%) stddev-sans-first:15.66 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: Values: 72.0 72.0 83.0 96.0 74.0 73.0 75.0 119.0 89.0 73.0 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: [#4] audio-oscillator Cycles:10 Average:105.60 Median:94.50 stddev:17.82 (18.9%) stddev-sans-first:18.48 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: Values: 95.0 95.0 128.0 95.0 94.0 95.0 132.0 94.0 94.0 134.0 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: [#5] imaging-gaussian-blur Cycles:10 Average:109.20 Median:109.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: Values: 109.0 110.0 109.0 109.0 109.0 109.0 110.0 109.0 109.0 109.0 01:00:05 INFO - 2015-11-24 01:00:05,254 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: [#6] imaging-darkroom Cycles:10 Average:147.20 Median:147.50 stddev:0.79 (0.5%) stddev-sans-first:0.71 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: Values: 146.0 148.0 146.0 148.0 147.0 147.0 147.0 148.0 147.0 148.0 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.44 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: Values: 96.0 96.0 96.0 95.0 95.0 95.0 95.0 95.0 95.0 95.0 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: [#8] json-parse-financial Cycles:10 Average:71.20 Median:71.00 stddev:3.08 (4.3%) stddev-sans-first:3.24 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: Values: 70.0 71.0 71.0 71.0 72.0 70.0 72.0 79.0 68.0 68.0 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: [#9] json-stringify-tinderbox Cycles:10 Average:68.90 Median:69.00 stddev:0.74 (1.1%) stddev-sans-first:0.71 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: Values: 68.0 70.0 69.0 69.0 70.0 69.0 68.0 69.0 69.0 68.0 01:00:05 INFO - 2015-11-24 01:00:05,255 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: [#10] stanford-crypto-aes Cycles:10 Average:84.30 Median:84.00 stddev:2.67 (3.2%) stddev-sans-first:1.87 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: Values: 90.0 82.0 84.0 83.0 84.0 84.0 82.0 82.0 84.0 88.0 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: [#11] stanford-crypto-ccm Cycles:10 Average:123.30 Median:123.00 stddev:3.56 (2.9%) stddev-sans-first:3.77 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: Values: 123.0 123.0 123.0 129.0 126.0 123.0 128.0 118.0 121.0 119.0 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.60 Median:146.50 stddev:6.65 (4.5%) stddev-sans-first:6.86 01:00:05 INFO - 2015-11-24 01:00:05,256 DEBUG : BROWSER_OUTPUT: Values: 148.0 136.0 150.0 138.0 145.0 137.0 148.0 145.0 154.0 135.0 01:00:05 INFO - 2015-11-24 01:00:05,257 DEBUG : BROWSER_OUTPUT: 01:00:05 INFO - 2015-11-24 01:00:05,257 DEBUG : BROWSER_OUTPUT: [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.50 Median:68.50 stddev:0.97 (1.4%) stddev-sans-first:1.01 01:00:05 INFO - 2015-11-24 01:00:05,257 DEBUG : BROWSER_OUTPUT: Values: 68.0 69.0 67.0 70.0 68.0 68.0 70.0 68.0 69.0 68.0 01:00:05 INFO - 2015-11-24 01:00:05,257 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:00:05 INFO - 2015-11-24 01:00:05,257 DEBUG : BROWSER_OUTPUT: 01:00:06 INFO - 2015-11-24 01:00:06,209 INFO : Browser exited with error code: 0 01:00:06 INFO - 2015-11-24 01:00:06,266 INFO : Completed test kraken (00:01:00) 01:00:06 INFO - 2015-11-24 01:00:06,266 INFO : Starting test v8_7 01:00:06 INFO - 2015-11-24 01:00:06,266 DEBUG : operating with platform_type : linux_ 01:00:06 INFO - 2015-11-24 01:00:06,267 INFO : Initialising browser for v8_7 test... 01:00:06 INFO - 2015-11-24 01:00:06,273 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkO22aC/profile http://localhost:58543/getInfo.html 01:00:10 INFO - 2015-11-24 01:00:10,266 DEBUG : BROWSER_OUTPUT: __metrics Screen width/height:1600/1200 01:00:10 INFO - 2015-11-24 01:00:10,266 DEBUG : BROWSER_OUTPUT: colorDepth:24 01:00:10 INFO - 2015-11-24 01:00:10,266 DEBUG : BROWSER_OUTPUT: Browser inner width/height: 1024/697 01:00:10 INFO - 2015-11-24 01:00:10,266 DEBUG : BROWSER_OUTPUT: __metrics 01:00:10 INFO - 2015-11-24 01:00:10,428 DEBUG : BROWSER_OUTPUT: JavaScript error: resource:///modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 01:00:11 INFO - 2015-11-24 01:00:11,692 INFO : Browser initialized. 01:00:11 INFO - 2015-11-24 01:00:11,693 INFO : Running cycle 1/1 for v8_7 test... 01:00:11 INFO - 2015-11-24 01:00:11,693 DEBUG : command line: /builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkO22aC/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1 01:00:23 INFO - 2015-11-24 01:00:23,586 DEBUG : BROWSER_OUTPUT: RSS: Main: 140251136 01:00:23 INFO - 2015-11-24 01:00:23,587 DEBUG : BROWSER_OUTPUT: 01:00:44 INFO - 2015-11-24 01:00:44,959 DEBUG : BROWSER_OUTPUT: Cycle 1(1): loaded http://localhost:58543/tests/v8_7/run.html (next: http://localhost:58543/tests/v8_7/run.html) 01:00:45 INFO - 2015-11-24 01:00:45,218 DEBUG : BROWSER_OUTPUT: RSS: Main: 444485632 01:00:45 INFO - 2015-11-24 01:00:45,218 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,218 DEBUG : BROWSER_OUTPUT: __start_tp_report 01:00:45 INFO - 2015-11-24 01:00:45,218 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load 01:00:45 INFO - 2015-11-24 01:00:45,218 DEBUG : BROWSER_OUTPUT: _x_x_mozilla_page_load_details 01:00:45 INFO - 2015-11-24 01:00:45,218 DEBUG : BROWSER_OUTPUT: |i|pagename|runs| 01:00:45 INFO - 2015-11-24 01:00:45,218 DEBUG : BROWSER_OUTPUT: |0;Richards;186.56716417910448 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |1;DeltaBlue;186.3238308179616 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |2;Encrypt;278.9400278940028 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |3;Decrypt;4995.024875621891 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |4;RayTrace;1976.2845849802372 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |5;Earley;800 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |6;Boyer;12537.5 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |7;RegExp;25846.153846153848 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |8;Splay;628.5355122564425 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: |9;NavierStokes;4835.748792270531 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: __end_tp_report 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: __startTimestamp1448355645211__endTimestamp 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: ------- Summary: start ------- 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: Number of tests: 10 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,219 DEBUG : BROWSER_OUTPUT: [#0] Richards Cycles:1 Average:186.57 Median:186.57 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: Values: 186.6 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: [#1] DeltaBlue Cycles:1 Average:186.32 Median:186.32 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: Values: 186.3 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: [#2] Encrypt Cycles:1 Average:278.94 Median:278.94 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: Values: 278.9 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: [#3] Decrypt Cycles:1 Average:4995.02 Median:4995.02 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: Values: 4995.0 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: [#4] RayTrace Cycles:1 Average:1976.28 Median:1976.28 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: Values: 1976.3 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: [#5] Earley Cycles:1 Average:800.00 Median:800.00 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,220 DEBUG : BROWSER_OUTPUT: Values: 800.0 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: [#6] Boyer Cycles:1 Average:12537.50 Median:12537.50 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: Values: 12537.5 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: [#7] RegExp Cycles:1 Average:25846.15 Median:25846.15 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: Values: 25846.2 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: [#8] Splay Cycles:1 Average:628.54 Median:628.54 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: Values: 628.5 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: [#9] NavierStokes Cycles:1 Average:4835.75 Median:4835.75 stddev:0.00 (0.0%) 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: Values: 4835.7 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: -------- Summary: end -------- 01:00:45 INFO - 2015-11-24 01:00:45,221 DEBUG : BROWSER_OUTPUT: 01:00:46 INFO - 2015-11-24 01:00:46,149 INFO : Browser exited with error code: 0 01:00:46 INFO - 2015-11-24 01:00:46,164 INFO : Completed test v8_7 (00:00:39) 01:00:46 INFO - 2015-11-24 01:00:46,289 INFO : Completed test suite (00:20:18) 01:00:46 INFO - 2015-11-24 01:00:46,289 DEBUG : Working with test: dromaeo_css 01:00:46 INFO - 2015-11-24 01:00:46,289 DEBUG : Generating results file: dromaeo_css 01:00:46 INFO - 2015-11-24 01:00:46,290 DEBUG : Working with test: kraken 01:00:46 INFO - 2015-11-24 01:00:46,290 DEBUG : Generating results file: kraken 01:00:46 INFO - 2015-11-24 01:00:46,291 INFO : javascript benchmark 01:00:46 INFO - 2015-11-24 01:00:46,291 DEBUG : Working with test: v8_7 01:00:46 INFO - 2015-11-24 01:00:46,291 DEBUG : Generating results file: v8_7 01:00:46 INFO - 2015-11-24 01:00:46,291 INFO : Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:00:46 INFO - 2015-11-24 01:00:46,360 DEBUG : process_Request line: dromaeo_css graph.html#tests=[[72,132,35]] 01:00:46 INFO - 2015-11-24 01:00:46,360 DEBUG : process_Request line: dromaeo_css 6162.23 graph.html#tests=[[72,132,35]] 01:00:46 INFO - 2015-11-24 01:00:46,360 INFO : Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:00:46 INFO - 2015-11-24 01:00:46,482 DEBUG : process_Request line: kraken 1520.20 graph.html#tests=[[232,132,35]] 01:00:46 INFO - 2015-11-24 01:00:46,482 INFO : Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 01:00:46 INFO - 2015-11-24 01:00:46,629 DEBUG : process_Request line: v8_7 19572.19 graph.html#tests=[[230,132,35]] 01:00:46 INFO - 2015-11-24 01:00:46,630 INFO : javascript benchmark 01:00:46 INFO - 2015-11-24 01:00:46,634 INFO : PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2598.947426292352, 2683.5303821831176, 2685.7582817546418, 2692.2057992892096, 2704.5943108533725, 4507.481639611446, 4631.189541830179, 4665.136949664315, 4689.57793798558, 4708.434987801465, 4618.538146185379, 4630.12027714734, 4705.082508910764, 4719.362886010387, 4730.432348118231, 4284.892877678059, 4315.180115778008, 4333.848315308965, 4350.80421381037, 4394.912101757963, 4352.3471479278205, 4391.187630288407, 4415.183191109639, 4420.491643460995, 4437.1125774844995, 4188.72773269738, 4274.7435153890865, 4299.419578356944, 4392.472903251598, 4396.428464299621, 4339.175556644227, 4348.782560871975, 4351.325544540601, 4351.825926962918, 4379.430674012358, 4311.82752689892, 4313.870583882457, 4316.762578058206, 4355.673324500675, 4364.650827933758, 4405.427294451701, 4510.21071312519, 4550.908981820378, 4563.840265590721, 4611.723296602215, 5000.67495612784, 5041.092603331399, 5045.318881950926, 5049.368828896388, 5095.464976177522, 5078.695278283315, 5083.161278389061, 5084.237364395333, 5088.440271570124, 5090.872728181788, 4555.817767289304, 4656.8602941911795, 4673.883152921204, 4684.039771846729, 4768.094062128184, 5116.488351164928, 5130.486951304914, 5137.51193636604, 5144.408393034774, 5182.896342073137, 4933.671187956519, 4944.60443164546, 4952.777125029383, 4953.380827396575, 4992.0, 4802.591779698765, 4899.2896030075435, 4914.189158788831, 4914.827981020647, 4929.975350123226, 5022.949770502249, 5023.949760502422, 5032.370953630796, 5032.421271553818, 5041.621878359138, 4989.276554899592, 4991.301217829507, 4992.750362481861, 4993.700377977333, 5038.748062596929, 4015.3374693175297, 4170.9582904171175, 4201.7268877522865, 4208.200441916088, 4251.681123915719, 3521.9119522012156, 3607.0801945503727, 3609.097725568608, 3609.639036096369, 3625.2568223514645, 4315.331123675835, 4331.177076355482, 4335.523092459827, 4339.138167031345, 4375.01562148514, 5049.0, 5054.721990290495, 5056.898862022813, 5067.4932506749765, 5082.415522214993, 4166.291730405838, 4256.404103425523, 4257.254980378421, 4258.339957306561, 4354.586314300136, 4438.201123797748, 4481.395011673448, 4492.191405547033, 4493.326001099861, 4533.0, 4802.135615589227, 4811.78346974387, 4813.350197723263, 4819.204831202812, 4850.927236091461, 4753.572178503813, 4849.369581954465, 4852.369192005158, 4930.161872481615, 5056.7724452399, 4787.40157480315, 4811.4707382188635, 4828.734419606955, 4829.2997515359375, 4872.951270487391, 5002.274670172877, 5010.073136469765, 5020.422651395136, 5021.899562008813, 5031.195008798574, 4739.620830333496, 4848.9757551212015, 4849.539293767087, 4919.311296418433, 5049.444561098203, 4856.1016212000895, 4882.755862206946, 4890.168671325812, 4891.804327826847, 4941.777620007037, 4845.961615850483, 4873.634477414137, 4882.389701287339, 4882.462929077869, 4930.309756634002, 4586.77066146698, 4644.767761611974, 4677.2750223715375, 4679.625629949528, 4762.499937506651, 4868.586170175575, 4912.95087049125, 4922.163232250455, 4925.21196608541, 4926.261060840902, 4802.27965805132, 4814.566688997867, 4814.5907597854575, 4816.710997340171, 4843.612510999182], "unit": "ms", "name": "dojo.html", "value": 4593.521673274711}, {"lowerIsBetter": false, "replicates": [551.1677367175566, 561.6601955816731, 561.9522340601048, 566.8412844403566, 574.5518495573455, 27063.188104356876, 35806.46290305644, 36690.0, 36791.0, 36831.26337473252, 38317.80841095791, 38824.0, 38899.41650875232, 38910.8054459728, 38937.805310973476, 7041.612711300876, 7149.928500714978, 7741.806454838617, 7907.327877130451, 7925.048994120685, 9930.404175749441, 10051.949740251288, 10130.797384052314, 10164.237682173829, 10169.135623471977, 9937.205023598131, 10062.19502439803, 10075.798484030314, 10094.394336339843, 10096.0, 7153.928460715404, 7329.303716146957, 7343.045404097486, 9817.558209880572, 9861.408315501058, 9750.609975601039, 9916.752081197956, 9917.157041651397, 9922.206223502102, 9925.90074099257, 35432.82283588566, 35838.0, 35882.0, 35891.64108358909, 35951.101222469384, 2585.0952166741677, 2705.4183350579524, 2755.5040092783292, 2951.940961180786, 3121.562981182636, 26127.0, 26570.46859062808, 26634.467310653872, 26712.866435667893, 26768.732312677013, 3298.719608833252, 3320.850561724704, 3353.765236433451, 3375.594928608583, 3428.142964258935, 214366.0, 216366.0, 216576.0, 216790.0, 216791.91604042036, 48073.27890081651, 49358.753206234454, 53689.46310536923, 58980.705096474245, 60506.39493605096, 53265.73367133139, 53376.733116334944, 53477.465225347245, 53486.465135348924, 53618.46381536213, 13663.658408539668, 13862.653433664038, 13862.65343366424, 13866.376013079234, 13873.58379248624, 10542.578296868192, 10601.098906593026, 10631.787364252827, 10633.680989570325, 10803.297785643908, 18389.90805045966, 18604.906975465037, 18615.162317695736, 18638.720419193724, 18660.53348666267, 7376.96311518439, 7675.462717609714, 7685.769426917202, 7713.961430192813, 7778.611069446505, 823.9382046346548, 854.5385491834464, 866.2982983783156, 946.5267366316841, 967.8596603492454, 29979.400411992076, 30944.535831962537, 31186.84406577998, 31384.37231255362, 31712.36575268482, 872.7774417523491, 894.2130924786146, 918.7473444802732, 942.6276620734772, 970.1850445625709, 13026.41381137851, 13048.34758262083, 13164.275964822027, 13181.209127452383, 13268.535601254103, 328375.0, 334100.0, 334362.0, 336154.0, 336489.0, 44606.55393446024, 45228.3215751764, 45253.0, 45325.093498129856, 45367.31949020767, 1033.426448321174, 1104.5692180049787, 1135.3017893995134, 1207.4506099724604, 1230.7046308885804, 22039.889800550896, 22114.88942555277, 22603.208887688852, 22668.773312266665, 22768.316950490847, 34947.47578786269, 36376.09059773527, 36798.44802328021, 36861.26277474382, 36861.81569092245, 192996.0, 323634.0, 333476.0, 333988.0, 334171.0, 27518.0, 27739.0, 28013.719862801925, 28015.159545213675, 28030.579541306488, 36119.45820812637, 36263.45604815877, 36591.26817463689, 36931.0, 36993.0, 29915.102546923627, 31475.52786708247, 31527.52708709417, 32143.839280803448, 32533.34933301368, 31589.47184242794, 32071.839640801645, 32580.0, 32664.83667581647, 32728.836355818068, 32690.50964235586, 32836.83581582077, 36672.0, 37485.0, 37845.243095138496, 28811.5678264822, 30216.84891575616, 30460.238494037825, 30575.96516171343, 30674.0, 23536.52926941486, 23584.52830943406, 23861.642075368538, 23995.400114997265, 24148.39629009289], "unit": "ms", "name": "ext.html", "value": 17034.780499229793}, {"lowerIsBetter": false, "replicates": [332.2192846809998, 332.4730302470583, 332.96448046575154, 332.99500507492394, 333.02589924470914, 12447.813282800766, 12814.743705125915, 15278.465253716122, 15691.84308156918, 15895.125768082751, 10047.748806279847, 10110.696679099621, 10553.155747540197, 10555.313904596196, 10773.730656733585, 4520.254158063924, 4655.301704744282, 4656.092062047902, 4656.837010704626, 4658.534146585332, 3367.24237046665, 3455.602605700339, 4682.157211701892, 4712.764361781914, 5055.721935293557, 5183.714895680736, 5184.948150518503, 5193.246979188016, 5206.193040078775, 5212.270282160501, 5109.591232701394, 5228.843134705927, 5234.241035049935, 5242.0, 5250.842474725745, 5041.369828771403, 5048.368953880765, 5053.69677819332, 5058.392992840846, 5060.898782024339, 11433.542658293742, 13596.59210223695, 18081.909590452095, 18636.068196590117, 18689.626207475776, 1659.6597697471989, 1686.4350442601742, 1707.4536148432508, 1714.7856517935259, 1772.9468115956543, 9363.297752668577, 9421.293402994803, 10013.257972228055, 10216.591336346537, 12648.810267845989, 1641.2040160522138, 1659.7178479658487, 1663.8336166383265, 1687.0805411051006, 1754.7104727719911, 53042.0, 54384.45615543833, 54479.0, 55404.0, 55679.721601391735, 8886.644534218689, 8967.327450441244, 9034.63861445548, 9239.429297019522, 9374.390664606779, 11216.943915280372, 11303.773924521463, 11304.0, 11306.886931130748, 11317.151213659008, 6026.337102918676, 6088.330283668793, 6134.294556126102, 6149.13912052313, 6171.660558669317, 5790.334111577223, 5799.101139323411, 5811.186433899257, 5818.6217895836635, 5827.59206855516, 3871.0, 3992.960070399317, 4028.5568587455355, 4031.5565287818317, 4125.824140120051, 1568.8431156884449, 1649.4144578674398, 1716.1379902805347, 1716.45107016081, 1738.452387497934, 818.2308629887887, 868.2576397180446, 882.5454890731279, 888.4846788862574, 965.5461932891529, 14556.199409032393, 14602.561923142322, 14830.40678372853, 15196.240187990556, 15247.0, 734.2657342657343, 795.7652492514723, 839.7186942374251, 843.7004863273572, 919.4483310013939, 8610.268127209258, 8734.781630459289, 8806.898291752643, 8887.11128887119, 8909.821803563893, 442653.0, 451979.0, 454900.0, 457013.8642374635, 477420.0, 68818.65590672115, 69416.0, 69440.0, 70238.0, 71093.64453177701, 1004.5881188712739, 1004.7940172264668, 1010.661428421487, 1017.1049476460668, 1021.6322124035341, 13742.106763060368, 13781.586552403443, 13818.614568354162, 13972.79040814409, 13984.091034082752, 30415.847920760254, 30481.847590761903, 30952.0714378569, 31211.375772484877, 31320.53019204668, 41773.37339939964, 42186.57813421827, 42205.36691949562, 42735.0, 42839.14321713486, 8857.335699822668, 9010.819783604422, 9084.727458176265, 9094.954525227331, 9199.218066464426, 14816.407343706562, 15587.35015047422, 16110.355585776437, 16383.344666213217, 16388.180590970165, 12465.252084874937, 12826.102172847812, 12885.742285154432, 13311.201327920357, 13579.45682172702, 11933.403329833647, 12939.870601293867, 13119.803202952155, 13343.532976345781, 13385.464581416634, 10287.130555745958, 13241.602751917459, 14285.64285892861, 14500.782488262896, 14688.82489400824, 8204.097549269694, 8232.17678232172, 8556.529390883561, 8687.565621718762, 8715.52064636451, 13386.26375549354, 13629.727405451637, 13647.249401283025, 13893.30533473302, 13974.930125349309], "unit": "ms", "name": "jquery.html", "value": 7873.346385725695}, {"lowerIsBetter": false, "replicates": [1164.2490593567145, 1590.1572166751623, 1626.7153248181564, 1635.8936669116506, 1663.0936139803814, 5847.122931560268, 6338.841528961778, 6518.967405162967, 6522.9021564676505, 6524.445422139124, 6736.66316684165, 6775.525713200078, 6793.320667933204, 6795.830104247396, 6799.0, 1734.1675995522157, 1757.411267225481, 2049.9077541510633, 2073.699313599527, 2075.6678931370984, 2026.9391918242402, 2054.260466232155, 2066.917323307066, 2069.668852983523, 2070.710100585919, 1975.5456245063644, 2019.1317733374642, 2019.6566583680735, 2030.5938812237612, 2040.3776848061336, 1980.3167907072036, 2047.37555045711, 2082.6771850363066, 2086.019570801728, 2086.040421406155, 2064.886431246281, 2094.1623350659856, 2094.9266775662777, 2096.706461095448, 2098.569793192392, 6534.0, 6625.0, 6630.403263706241, 6634.170728658918, 6638.20341559016, 3956.4460975463458, 3976.602339766029, 3976.9005774855573, 4012.177503611782, 4013.0769922917602, 2575.5364034473787, 2696.4876673431986, 2700.3249187703072, 2715.7691596214345, 2719.265798234466, 757.8446418484252, 857.5112186053951, 862.1292494580456, 865.7878819689154, 887.0685779931047, 8760.649574017032, 8915.108489151098, 8917.197452229266, 8923.286137109015, 8937.865932011026, 3648.3980143276594, 3669.0, 3731.6081811409413, 3752.9061773455337, 3761.3793724035227, 7495.8500829983095, 7496.100467943882, 7509.0, 7525.924740752523, 7534.171241163468, 4115.526714427879, 4132.421460995463, 4134.937975930364, 4141.482314710661, 4143.751374917515, 3821.7197238925273, 3823.617638236154, 3823.866164684223, 3824.6749026333073, 3827.73205875586, 3046.84765761711, 3054.4043911437057, 3058.2660161561066, 3090.0, 3093.443180227581, 903.9050899655573, 907.2243232036645, 912.7991841794794, 914.5518695839124, 915.2449229385784, 1060.3319908457777, 1077.0, 1115.297362661518, 1131.7396998690347, 1132.7281452451352, 6535.248446428626, 6536.575122617015, 6550.312217217123, 6553.2136143663065, 6563.113979612786, 428.6463667474284, 441.9381286619876, 442.6879050269552, 443.60740744441404, 456.5571395746121, 5020.849374518771, 5032.748362581856, 5059.46875578059, 5069.594432445396, 5071.163258062378, 8030.39772017101, 8095.069067057246, 8133.146019667968, 8160.83678326442, 8229.711960081368, 7982.880256796153, 8026.678932842738, 8034.116247212802, 8034.718784842503, 8060.879086813702, 6250.124982502453, 6370.331115232834, 6388.808335749842, 6399.488040956712, 6433.967830160819, 6225.190725205875, 6246.593971391845, 6246.750129994749, 6252.062190671254, 6259.311475737574, 7155.819289817122, 7351.926480735338, 7367.447441441806, 7385.224551422023, 7420.03539539878, 7388.704451821867, 7498.0, 7537.057867766529, 7543.283388078124, 7546.3962882968135, 5522.337319521683, 5567.387587365306, 5570.442955704397, 5580.497755202051, 5581.6930068846605, 6321.367863213642, 6329.810105696836, 6346.714397852015, 6370.331115232834, 6378.585391949508, 5748.971255143698, 5788.044972579477, 6051.697415129314, 6053.061775424816, 6266.561340706106, 6013.879722405615, 6037.154798328325, 6044.516438684983, 6097.054956481752, 6104.20645316106, 6172.351903050115, 6205.0, 6206.0, 6220.098085777628, 6224.595401298901, 5696.686682232517, 5767.048437007847, 5774.451427114417, 5778.046622307273, 5780.971095144498, 5141.948580514297, 5882.852928676817, 5924.940750592439, 5929.644221346733, 5942.168096466585], "unit": "ms", "name": "mootools.html", "value": 3821.856565820375}, {"lowerIsBetter": false, "replicates": [307.5893681934617, 312.3923967882468, 313.1466753097809, 319.39952888569485, 321.18259030766694, 5226.18994055921, 5359.410464848873, 5384.40771515133, 5400.486953739398, 5406.486383793538, 5136.794528218876, 5307.416184219733, 5307.469253074691, 5326.360836699591, 5336.546393556552, 4211.747295162285, 4228.72513286637, 4233.407322974786, 4235.491740991078, 4243.830246790125, 3988.880333589997, 4056.249593825152, 4061.87814365568, 4063.918721625566, 4227.429297044906, 4031.2340655275552, 4034.6570541504007, 4048.5951404859575, 4135.669146468275, 4137.855175068873, 4173.3114036184, 4178.310578754502, 4188.68584856137, 4190.727602705814, 4197.580241975808, 3708.627807711164, 3710.7959062251566, 3711.554613446404, 3713.6843368313725, 3715.8142092895246, 5053.84838454847, 5166.715830629351, 5167.457416971239, 5169.741512924339, 5171.689698618095, 4810.807567697288, 4813.302071199656, 4816.470188279286, 4816.807327706888, 4819.44576373718, 5598.580106491989, 5599.076152434844, 5604.0, 5605.887882242332, 5606.327240731139, 3820.7134464914966, 3931.390634451636, 3935.1932853765197, 4023.758574485511, 4057.4116753070934, 5878.088896221093, 5901.527877769769, 5902.1146827976145, 5913.586048976574, 5920.644761314292, 4183.891268813767, 4184.66522678185, 4185.016521117535, 4185.058361868616, 4188.204241194163, 4217.0511634881905, 4248.1078973415315, 4249.617534421855, 4253.170631726845, 4255.021345090647, 4674.485806561275, 4771.308160316735, 4786.44955830077, 4786.617070634341, 4786.95213047872, 5624.85937851557, 5627.8593035174445, 5632.2678051853, 5641.492265696107, 5641.689707066151, 1488.8660020597981, 1512.5462361291789, 1512.6520900193018, 1512.9697406051816, 1515.0758037597057, 1023.8976102389702, 1035.7410647338165, 1045.0751085289573, 1047.1361127070197, 1048.5596049659162, 4948.0103979204305, 4955.008998200375, 4957.553820156203, 4957.826476073392, 4960.875978100504, 5852.0, 5852.94147058524, 5854.0, 5858.2677165354335, 5859.2090067841145, 4955.90088198234, 4957.4794646561595, 4958.281049247911, 4963.329950456642, 4963.875903102379, 3093.566900633913, 3129.2489802447703, 3139.372125574894, 3163.6994485523837, 3164.936701265962, 5515.841673248663, 5520.91718624221, 5526.281583394133, 5526.557875369961, 5533.6403133796175, 5983.1623572699855, 5993.220881285492, 5994.310654274727, 5996.5202783777195, 6004.189434426384, 5521.309836270466, 5523.447655234525, 5529.917051244234, 5530.059889818741, 5533.0, 5640.689762062962, 5845.970770146122, 5851.502622277154, 5852.619579727304, 5854.092615644582, 5533.6403133796175, 5620.241267428844, 5663.235463212413, 5698.487136157766, 5709.115087161496, 5550.8057217997175, 5567.164925261243, 5570.2480165177185, 5571.969185700658, 5572.387037425961, 4210.221109094828, 4210.9789451053775, 4211.220924129046, 4217.325227963511, 4221.134667393116, 5867.706614669164, 5874.089516125007, 5874.559408044328, 5877.059670452707, 5883.705814709333, 5530.944690553043, 5686.147077938177, 5693.231413759255, 5698.715064246854, 5698.971505142447, 5688.744006519633, 5693.800716974886, 5696.259486266925, 5699.088145896637, 5703.857403564944, 5566.192902029102, 5572.498475137257, 5579.16312553104, 5579.637323573955, 5586.720663966867, 5564.387917329172, 5717.028105222205, 5728.255326807488, 5728.513076388554, 5736.942630573641, 5548.9722551386985, 5591.329040515164, 5593.972030139823, 5594.944050559442, 5606.6916319602815], "unit": "ms", "name": "prototype.html", "value": 4272.380743590625}, {"lowerIsBetter": false, "replicates": [606.5336601323436, 647.876903388356, 759.4000739415861, 771.9382449404048, 785.1559573458534, 10807.891921080796, 10976.12191024718, 11013.669589912295, 11016.11871050314, 11029.338239705623, 10981.286216395929, 11068.0, 11068.723281917955, 11073.003429691325, 11077.335359878412, 587.0841487279846, 597.8565144365365, 599.7181324777348, 599.8470390050531, 599.9940000600004, 604.8760004199129, 735.8712225360567, 748.8577170337645, 748.988765168523, 749.8987636669061, 763.152900280688, 768.9115751688571, 775.9301662850371, 777.0946846923356, 777.3858651665178, 767.6660652616102, 772.2624893226955, 772.9884051739228, 773.3619763694974, 773.7910764093691, 464.865189095162, 572.4590262202221, 573.1088157914442, 573.2576313673761, 573.9713014349265, 8913.955430222808, 11060.059894908942, 11452.427378631035, 11456.599019034295, 11461.713457163554, 11024.944875275653, 11132.833007504894, 11486.0, 11941.223820451643, 12209.633710988595, 9363.625454981793, 9368.34421590489, 9429.057094290585, 9471.621135154655, 9480.810383792354, 3221.7905836120576, 3262.771605987582, 3266.8856590019473, 3300.7359411247044, 3318.8340582970995, 41229.38155927663, 41263.793681031704, 41372.79313603443, 41546.58453415457, 42200.0, 9028.18746312835, 9262.490563018964, 9681.70954871355, 9840.852387214198, 9858.901410985798, 16982.23579938906, 16982.320707171573, 17059.573510662332, 17060.146992650567, 17073.231704573074, 6225.595336303126, 6312.431881130628, 6319.936800631935, 6367.299597044322, 6617.007448882706, 3458.066322093021, 3477.965220347764, 3498.9125271868406, 3517.6834084931966, 3530.435130379178, 2658.082961378321, 2668.159529748123, 2671.82633128846, 2689.838609683386, 2691.811573189858, 464.1737706881756, 470.5694289724932, 475.5648581547845, 478.44739326078434, 479.1136397664363, 451.8825105472601, 472.510951165542, 516.339085969959, 543.9292891924025, 585.3648791061661, 6555.0, 7059.541129826544, 7235.095613048369, 7646.770596882103, 7894.960525197452, 482.6331987689311, 485.2333313364875, 486.4017258771731, 560.7784924954701, 608.412881569279, 3044.1932887784756, 3247.7270365109134, 3281.1633033576763, 3304.8512816923294, 3378.5607870976614, 46428.767856160506, 46662.76668616635, 46747.29879051817, 47010.0, 47048.2942755859, 41111.0, 41307.0, 42330.365044524355, 42341.15317693629, 45576.3163552547, 37173.065109798226, 37254.441183382274, 37525.81237093797, 41481.0, 43014.569854301684, 7317.268273172853, 7550.395968322631, 7728.661945583302, 7801.570913599807, 8041.0, 30626.0, 30897.0, 31581.526277105404, 31622.367552649277, 31674.36651267008, 38426.42360364541, 38564.6143538561, 40673.79663101665, 42061.36907946444, 42348.5765142357, 9276.397034192756, 9429.858552121861, 9503.61985520599, 9574.56914438838, 9601.47191904452, 9817.65638202688, 10027.247956403446, 10321.845172322572, 10443.164546836388, 10558.472076396303, 9505.524723763645, 9513.66702165421, 9604.66383676568, 9630.662926797528, 9947.751306217402, 10030.448325341884, 10043.447610381207, 10060.39637621745, 10064.132224826115, 10069.200181606739, 9653.372530785477, 9682.27382946296, 9717.076877696607, 9719.0, 9728.221742260745, 8322.417430779788, 8545.74362769118, 8565.050735049224, 8865.601047952729, 8985.910140898508, 8548.529830859363, 8731.738047858575, 8902.777430564029, 8910.153535414125, 9118.133777291147], "unit": "ms", "name": "yui.html", "value": 5442.4451951964975}], "name": "dromaeo_css", "value": 6162.230122695931}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [111.0, 114.0, 106.0, 112.0, 113.0, 113.0, 102.0, 114.0, 113.0, 106.0], "unit": "ms", "name": "ai-astar", "value": 110.4}, {"lowerIsBetter": true, "replicates": [155.0, 129.0, 151.0, 164.0, 134.0, 157.0, 160.0, 130.0, 174.0, 130.0], "unit": "ms", "name": "audio-beat-detection", "value": 148.4}, {"lowerIsBetter": true, "replicates": [161.0, 162.0, 160.0, 160.0, 160.0, 161.0, 164.0, 162.0, 163.0, 164.0], "unit": "ms", "name": "audio-dft", "value": 161.7}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 83.0, 96.0, 74.0, 73.0, 75.0, 119.0, 89.0, 73.0], "unit": "ms", "name": "audio-fft", "value": 82.6}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 128.0, 95.0, 94.0, 95.0, 132.0, 94.0, 94.0, 134.0], "unit": "ms", "name": "audio-oscillator", "value": 105.6}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 109.0, 109.0, 109.0, 109.0, 110.0, 109.0, 109.0, 109.0], "unit": "ms", "name": "imaging-gaussian-blur", "value": 109.2}, {"lowerIsBetter": true, "replicates": [146.0, 148.0, 146.0, 148.0, 147.0, 147.0, 147.0, 148.0, 147.0, 148.0], "unit": "ms", "name": "imaging-darkroom", "value": 147.2}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 96.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 95.0], "unit": "ms", "name": "imaging-desaturate", "value": 95.3}, {"lowerIsBetter": true, "replicates": [70.0, 71.0, 71.0, 71.0, 72.0, 70.0, 72.0, 79.0, 68.0, 68.0], "unit": "ms", "name": "json-parse-financial", "value": 71.2}, {"lowerIsBetter": true, "replicates": [68.0, 70.0, 69.0, 69.0, 70.0, 69.0, 68.0, 69.0, 69.0, 68.0], "unit": "ms", "name": "json-stringify-tinderbox", "value": 68.9}, {"lowerIsBetter": true, "replicates": [90.0, 82.0, 84.0, 83.0, 84.0, 84.0, 82.0, 82.0, 84.0, 88.0], "unit": "ms", "name": "stanford-crypto-aes", "value": 84.3}, {"lowerIsBetter": true, "replicates": [123.0, 123.0, 123.0, 129.0, 126.0, 123.0, 128.0, 118.0, 121.0, 119.0], "unit": "ms", "name": "stanford-crypto-ccm", "value": 123.3}, {"lowerIsBetter": true, "replicates": [148.0, 136.0, 150.0, 138.0, 145.0, 137.0, 148.0, 145.0, 154.0, 135.0], "unit": "ms", "name": "stanford-crypto-pbkdf2", "value": 143.6}, {"lowerIsBetter": true, "replicates": [68.0, 69.0, 67.0, 70.0, 68.0, 68.0, 70.0, 68.0, 69.0, 68.0], "unit": "ms", "name": "stanford-crypto-sha256-iterative", "value": 68.5}], "name": "kraken", "value": 1520.2}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [186.56716417910448], "unit": "score", "name": "Richards", "value": 189.21872}, {"lowerIsBetter": false, "replicates": [186.3238308179616], "unit": "score", "name": "DeltaBlue", "value": 354.85530600000016}, {"lowerIsBetter": false, "replicates": [278.9400278940028], "unit": "score", "name": "Encrypt", "value": 954.2588850000001}, {"lowerIsBetter": false, "replicates": [4995.024875621891], "unit": "score", "name": "Decrypt", "value": 53.289224103585696}, {"lowerIsBetter": false, "replicates": [1976.2845849802372], "unit": "score", "name": "RayTrace", "value": 374.434434}, {"lowerIsBetter": false, "replicates": [800.0], "unit": "score", "name": "Earley", "value": 833.0787499999997}, {"lowerIsBetter": false, "replicates": [12537.5], "unit": "score", "name": "Boyer", "value": 53.15756729810566}, {"lowerIsBetter": false, "replicates": [25846.153846153848], "unit": "score", "name": "RegExp", "value": 35.24644345238097}, {"lowerIsBetter": false, "replicates": [628.5355122564425], "unit": "score", "name": "Splay", "value": 129.65218100000004}, {"lowerIsBetter": false, "replicates": [4835.748792270531], "unit": "score", "name": "NavierStokes", "value": 306.881118881119}], "name": "v8_7", "value": 19572.188846152196}]} 01:00:46 INFO - RETURN: dromaeo_css: 6162.23 01:00:46 INFO - RETURN: kraken: 1520.20 01:00:46 INFO - RETURN: v8_7: 19572.19 01:00:46 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,35]]", "result": "19572.19"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,35]]", "result": "1520.20"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,35]]", "result": "6162.23"}}} 01:00:46 INFO - Return code: 0 01:00:46 INFO - # TBPL SUCCESS # 01:00:46 INFO - Running post-action listener: _resource_record_post_action 01:00:46 INFO - Running post-run listener: _resource_record_post_run 01:00:47 INFO - Total resource usage - Wall time: 1233s; CPU: 13.0%; Read bytes: 8192; Write bytes: 518156288; Read time: 128; Write time: 399480 01:00:47 INFO - install - Wall time: 14s; CPU: 13.0%; Read bytes: 0; Write bytes: 171433984; Read time: 0; Write time: 171140 01:00:47 INFO - run-tests - Wall time: 1220s; CPU: 13.0%; Read bytes: 4096; Write bytes: 342777856; Read time: 120; Write time: 227844 01:00:47 INFO - Running post-run listener: _upload_blobber_files 01:00:47 INFO - Blob upload gear active. 01:00:47 INFO - There are no files to upload in the directory. Skipping the blob upload mechanism ... 01:00:47 INFO - Copying logs to upload dir... 01:00:47 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1268.518845 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 8 secs) (at 2015-11-24 01:00:47.098874) ========= ========= Started set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-24 01:00:47.104494) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False build_url:https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.009899 build_url: 'https://queue.taskcluster.net/v1/task/AQWMZMQpQ7KVAuhl38f58Q/artifacts/public/build/firefox-45.0a1.en-US.linux-x86_64.tar.bz2' ========= master_lag: 0.04 ========= ========= Finished set props: build_url (results: 0, elapsed: 0 secs) (at 2015-11-24 01:00:47.155959) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 01:00:47.156301) ========= 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=0d7d1540fd7fba0c6b8b7f12000001dc-1448354155.4216-1981398658 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004561 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2015-11-24 01:00:47.205800) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-24 01:00:47.206117) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2015-11-24 01:00:47.206414) ========= ========= Total master_lag: 0.24 =========