builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-080 starttime: 1488734015.4 results: success (0) revision: 4b6a130cc3424f17b07220bd23c2c70c4f32e860 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.398906) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.399581) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.399900) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.439165) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.439848) ========= 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=781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-03-05 09:13:36-- 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: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 18.1M=0.001s 2017-03-05 09:13:36 (18.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.086757 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.543189) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.543953) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', '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=781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021657 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:35.595404) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-05 09:13:35.595782) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4b6a130cc3424f17b07220bd23c2c70c4f32e860 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 4b6a130cc3424f17b07220bd23c2c70c4f32e860 --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=781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-03-05 09:13:36,367 truncating revision to first 12 chars 2017-03-05 09:13:36,367 Setting DEBUG logging. 2017-03-05 09:13:36,367 attempt 1/10 2017-03-05 09:13:36,367 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/4b6a130cc342?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-03-05 09:13:37,206 unpacking tar archive at: mozilla-aurora-4b6a130cc342/testing/mozharness/ program finished with exit code 0 elapsedTime=1.148761 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-03-05 09:13:36.758302) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:36.758686) ========= script_repo_revision: 4b6a130cc3424f17b07220bd23c2c70c4f32e860 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:36.759136) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:36.759464) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-03-05 09:13:36.768535) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2017-03-05 09:13:36.768847) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora-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', 'Mozilla-Aurora-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora-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=781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:13:37 INFO - MultiFileLogger online at 20170305 09:13:37 in /builds/slave/test 09:13:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora-Non-PGO 09:13:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:13:37 INFO - {'append_to_log': False, 09:13:37 INFO - 'base_work_dir': '/builds/slave/test', 09:13:37 INFO - 'blob_upload_branch': 'Mozilla-Aurora-Non-PGO', 09:13:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:13:37 INFO - 'branch': 'Mozilla-Aurora-Non-PGO', 09:13:37 INFO - 'buildbot_json_path': 'buildprops.json', 09:13:37 INFO - 'config_files': ('talos/linux_config.py',), 09:13:37 INFO - 'default_actions': ('clobber', 09:13:37 INFO - 'read-buildbot-config', 09:13:37 INFO - 'download-and-extract', 09:13:37 INFO - 'populate-webroot', 09:13:37 INFO - 'create-virtualenv', 09:13:37 INFO - 'install', 09:13:37 INFO - 'run-tests'), 09:13:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:13:37 INFO - 'download_minidump_stackwalk': True, 09:13:37 INFO - 'download_symbols': 'ondemand', 09:13:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:13:37 INFO - 'tooltool.py': '/tools/tooltool.py', 09:13:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:13:37 INFO - '/tools/misc-python/virtualenv.py')}, 09:13:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:13:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:13:37 INFO - 'installer_path': 'installer.exe', 09:13:37 INFO - 'log_level': 'info', 09:13:37 INFO - 'log_name': 'talos', 09:13:37 INFO - 'log_to_console': True, 09:13:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:13:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:13:37 INFO - 'opt_config_files': (), 09:13:37 INFO - 'pip_index': False, 09:13:37 INFO - 'sps_profile': False, 09:13:37 INFO - 'sps_profile_interval': 0, 09:13:37 INFO - 'suite': 'dromaeojs', 09:13:37 INFO - 'system_bits': '32', 09:13:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:13:37 INFO - 'title': 'talos-linux64-ix-080', 09:13:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:13:37 INFO - 'use_talos_json': True, 09:13:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:13:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:13:37 INFO - 'work_dir': 'build'} 09:13:37 INFO - [mozharness: 2017-03-05 17:13:37.633783Z] Running clobber step. 09:13:37 INFO - Running pre-action listener: _resource_record_pre_action 09:13:37 INFO - Running main action method: clobber 09:13:37 INFO - rmtree: /builds/slave/test/build 09:13:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:13:38 INFO - Running post-action listener: _resource_record_post_action 09:13:38 INFO - [mozharness: 2017-03-05 17:13:38.571893Z] Finished clobber step (success) 09:13:38 INFO - [mozharness: 2017-03-05 17:13:38.571993Z] Running read-buildbot-config step. 09:13:38 INFO - Running pre-action listener: _resource_record_pre_action 09:13:38 INFO - Running main action method: read_buildbot_config 09:13:38 INFO - Using buildbot properties: 09:13:38 INFO - { 09:13:38 INFO - "project": "", 09:13:38 INFO - "product": "firefox", 09:13:38 INFO - "who": "kgupta@mozilla.com", 09:13:38 INFO - "installer_path": "public/build/target.tar.bz2", 09:13:38 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 09:13:38 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 09:13:38 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora talos dromaeojs", 09:13:38 INFO - "stage_platform": "linux64", 09:13:38 INFO - "basedir": "/builds/slave/test", 09:13:38 INFO - "buildnumber": 72, 09:13:38 INFO - "platform": "ubuntu64_hw", 09:13:38 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 09:13:38 INFO - "slavebuilddir": "test", 09:13:38 INFO - "taskId": "cnXzHulDRriEqkJyWAxJYA", 09:13:38 INFO - "branch": "mozilla-aurora", 09:13:38 INFO - "script_repo_revision": "production", 09:13:38 INFO - "revision": "4b6a130cc3424f17b07220bd23c2c70c4f32e860", 09:13:38 INFO - "slavename": "talos-linux64-ix-080", 09:13:38 INFO - "repo_path": "releases/mozilla-aurora" 09:13:38 INFO - } 09:13:38 INFO - Finding installer, test and symbols from parent task. 09:13:38 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/cnXzHulDRriEqkJyWAxJYA'}, attempt #1 09:13:39 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/cnXzHulDRriEqkJyWAxJYA'}, attempt #1 09:13:39 INFO - Task dependencies: JFveBITSQTeZAEnF1_PlPw 09:13:39 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw'}, attempt #1 09:13:39 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2 09:13:39 INFO - Set test_url: https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/test_packages.json 09:13:39 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.crashreporter-symbols.zip 09:13:39 INFO - Running post-action listener: _resource_record_post_action 09:13:39 INFO - [mozharness: 2017-03-05 17:13:39.958757Z] Finished read-buildbot-config step (success) 09:13:39 INFO - [mozharness: 2017-03-05 17:13:39.958974Z] Running download-and-extract step. 09:13:39 INFO - Running pre-action listener: _resource_record_pre_action 09:13:39 INFO - Running main action method: download_and_extract 09:13:39 INFO - mkdir: /builds/slave/test/build/tests 09:13:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:39 INFO - trying https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.test_packages.json 09:13:39 INFO - Downloading https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 09:13:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 09:13:40 INFO - Downloaded 896 bytes. 09:13:40 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 09:13:40 INFO - Using the following test package requirements: 09:13:40 INFO - {u'common': [u'target.common.tests.zip'], 09:13:40 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 09:13:40 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 09:13:40 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 09:13:40 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 09:13:40 INFO - u'mozbase': [u'target.common.tests.zip'], 09:13:40 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 09:13:40 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 09:13:40 INFO - u'web-platform': [u'target.common.tests.zip', 09:13:40 INFO - u'target.web-platform.tests.zip'], 09:13:40 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 09:13:40 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 09:13:40 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.common.tests.zip 09:13:40 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:13:40 INFO - Fetch https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.common.tests.zip into memory 09:13:41 INFO - Expected file size: 21861865 09:13:41 INFO - Obtained file size: 21861865 09:13:45 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 09:13:45 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.common.tests.zip 09:13:45 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.common.tests.zip'}, attempt #1 09:13:45 INFO - Fetch https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.common.tests.zip into memory 09:13:46 INFO - Expected file size: 21861865 09:13:46 INFO - Obtained file size: 21861865 09:13:50 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.talos.tests.zip 09:13:50 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 09:13:50 INFO - Fetch https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.talos.tests.zip into memory 09:13:51 INFO - Expected file size: 14403650 09:13:51 INFO - Obtained file size: 14403650 09:13:51 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:51 INFO - trying https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2 09:13:51 INFO - Downloading https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 09:13:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 09:13:52 INFO - Downloaded 66144359 bytes. 09:13:52 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2 09:13:52 INFO - mkdir: /builds/slave/test/properties 09:13:52 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:13:52 INFO - Writing to file /builds/slave/test/properties/build_url 09:13:52 INFO - Contents: 09:13:52 INFO - build_url:https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2 09:13:52 INFO - Running post-action listener: _resource_record_post_action 09:13:52 INFO - Running post-action listener: set_extra_try_arguments 09:13:52 INFO - [mozharness: 2017-03-05 17:13:52.733776Z] Finished download-and-extract step (success) 09:13:52 INFO - [mozharness: 2017-03-05 17:13:52.733873Z] Running populate-webroot step. 09:13:52 INFO - Running pre-action listener: _resource_record_pre_action 09:13:52 INFO - Running main action method: populate_webroot 09:13:52 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:13:52 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:13:52 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:13:52 INFO - '--tppagecycles', 09:13:52 INFO - '7'], 09:13:52 INFO - 'tests': ['tsvgm']}}, 09:13:52 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:13:52 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:13:52 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:13:52 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:13:52 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 09:13:52 INFO - 'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:13:52 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 09:13:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:13:52 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 09:13:52 INFO - 'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['damp', 'tps']}, 09:13:52 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 09:13:52 INFO - 'tests': ['damp', 'tps']}, 09:13:52 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['dromaeo_dom']}, 09:13:52 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:13:52 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['basic_compositor_video']}, 09:13:52 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 09:13:52 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['a11yr', 09:13:52 INFO - 'ts_paint', 09:13:52 INFO - 'tpaint', 09:13:52 INFO - 'sessionrestore', 09:13:52 INFO - 'sessionrestore_no_auto_restore', 09:13:52 INFO - 'tabpaint']}, 09:13:52 INFO - 'other-e10s': {'tests': ['a11yr', 09:13:52 INFO - 'ts_paint', 09:13:52 INFO - 'tpaint', 09:13:52 INFO - 'sessionrestore', 09:13:52 INFO - 'sessionrestore_no_auto_restore', 09:13:52 INFO - 'tabpaint']}, 09:13:52 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:13:52 INFO - 'ts_paint', 09:13:52 INFO - 'tpaint', 09:13:52 INFO - 'sessionrestore', 09:13:52 INFO - 'sessionrestore_no_auto_restore', 09:13:52 INFO - 'tabpaint']}, 09:13:52 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:13:52 INFO - 'ts_paint', 09:13:52 INFO - 'tpaint', 09:13:52 INFO - 'sessionrestore', 09:13:52 INFO - 'sessionrestore_no_auto_restore', 09:13:52 INFO - 'tabpaint']}, 09:13:52 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['a11yr', 09:13:52 INFO - 'ts_paint', 09:13:52 INFO - 'tpaint', 09:13:52 INFO - 'sessionrestore', 09:13:52 INFO - 'sessionrestore_no_auto_restore', 09:13:52 INFO - 'tabpaint']}, 09:13:52 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['a11yr', 09:13:52 INFO - 'ts_paint', 09:13:52 INFO - 'tpaint', 09:13:52 INFO - 'sessionrestore', 09:13:52 INFO - 'sessionrestore_no_auto_restore', 09:13:52 INFO - 'tabpaint']}, 09:13:52 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['tsvgx', 09:13:52 INFO - 'tsvgr_opacity', 09:13:52 INFO - 'tart', 09:13:52 INFO - 'tscrollx', 09:13:52 INFO - 'cart', 09:13:52 INFO - 'tsvg_static']}, 09:13:52 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:13:52 INFO - 'tsvgr_opacity', 09:13:52 INFO - 'tart', 09:13:52 INFO - 'tscrollx', 09:13:52 INFO - 'cart', 09:13:52 INFO - 'tsvg_static']}, 09:13:52 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 09:13:52 INFO - 'talos_options': ['--disable-e10s'], 09:13:52 INFO - 'tests': ['tp5o']}, 09:13:52 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 09:13:52 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 09:13:52 INFO - 'talos_options': ['--disable-e10s', 09:13:52 INFO - '--xperf_path', 09:13:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:13:52 INFO - 'tests': ['tp5n']}, 09:13:52 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 09:13:52 INFO - 'talos_options': ['--xperf_path', 09:13:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:13:52 INFO - 'tests': ['tp5n']}}, 09:13:52 INFO - 'talos.zip': {'path': '', 09:13:52 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:13:52 INFO - Running post-action listener: _resource_record_post_action 09:13:52 INFO - [mozharness: 2017-03-05 17:13:52.746995Z] Finished populate-webroot step (success) 09:13:52 INFO - [mozharness: 2017-03-05 17:13:52.747084Z] Running create-virtualenv step. 09:13:52 INFO - Running pre-action listener: _resource_record_pre_action 09:13:52 INFO - Running main action method: create_virtualenv 09:13:52 INFO - Creating virtualenv /builds/slave/test/build/venv 09:13:52 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 09:13:52 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:13:52 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:13:52 INFO - Using real prefix '/usr' 09:13:52 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:13:53 INFO - Installing distribute.............................................................................................................................................................................................done. 09:13:55 INFO - Installing pip.................done. 09:13:55 INFO - Return code: 0 09:13:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 09:13:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 09:13:55 INFO - Reading from file tmpfile_stdout 09:13:55 INFO - Output received: 09:13:55 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 09:13:55 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:13:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:13:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 09:13:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 09:13:55 INFO - Using env: {'DISPLAY': ':0', 09:13:55 INFO - 'HOME': '/home/cltbld', 09:13:55 INFO - 'LANG': 'en_US.UTF-8', 09:13:55 INFO - 'LANGUAGE': 'en_US:en', 09:13:55 INFO - 'LOGNAME': 'cltbld', 09:13:55 INFO - 'MAIL': '/var/mail/cltbld', 09:13:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:55 INFO - 'MOZ_NO_REMOTE': '1', 09:13:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:55 INFO - 'NO_EM_RESTART': '1', 09:13:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:13:55 INFO - 'PWD': '/builds/slave/test', 09:13:55 INFO - 'SHELL': '/bin/bash', 09:13:55 INFO - 'SHLVL': '1', 09:13:55 INFO - 'TERM': 'linux', 09:13:55 INFO - 'TMOUT': '86400', 09:13:55 INFO - 'USER': 'cltbld', 09:13:55 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:13:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:55 INFO - '_': '/tools/buildbot/bin/python'} 09:13:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13:55 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 09:13:55 INFO - Cleaning up... 09:13:55 INFO - Return code: 0 09:13:55 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:13:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:13:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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>=3.1.1'] in /builds/slave/test/build 09:13:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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>=3.1.1 09:13:55 INFO - Using env: {'DISPLAY': ':0', 09:13:55 INFO - 'HOME': '/home/cltbld', 09:13:55 INFO - 'LANG': 'en_US.UTF-8', 09:13:55 INFO - 'LANGUAGE': 'en_US:en', 09:13:55 INFO - 'LOGNAME': 'cltbld', 09:13:55 INFO - 'MAIL': '/var/mail/cltbld', 09:13:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:55 INFO - 'MOZ_NO_REMOTE': '1', 09:13:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:55 INFO - 'NO_EM_RESTART': '1', 09:13:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:13:55 INFO - 'PWD': '/builds/slave/test', 09:13:55 INFO - 'SHELL': '/bin/bash', 09:13:55 INFO - 'SHLVL': '1', 09:13:55 INFO - 'TERM': 'linux', 09:13:55 INFO - 'TMOUT': '86400', 09:13:55 INFO - 'USER': 'cltbld', 09:13:55 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:13:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:55 INFO - '_': '/tools/buildbot/bin/python'} 09:13:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13:55 INFO - Downloading/unpacking psutil>=3.1.1 09:13:55 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 09:13:55 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 09:13:55 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 09:13:55 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 09:13:55 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 09:13:55 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 09:13:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:13:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:13:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:13:58 INFO - Installing collected packages: psutil 09:13:58 INFO - Running setup.py install for psutil 09:13:58 INFO - building 'psutil._psutil_linux' extension 09:13:58 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 09:13:58 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 09:13:58 INFO - building 'psutil._psutil_posix' extension 09:13:58 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 09:13:58 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 09:13:58 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:13:58 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:13:58 INFO - Successfully installed psutil 09:13:58 INFO - Cleaning up... 09:13:58 INFO - Return code: 0 09:13:58 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:13:58 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:13:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:58 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:13:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:13:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:13:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:13:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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.3'] in /builds/slave/test/build 09:13:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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.3 09:13:58 INFO - Using env: {'DISPLAY': ':0', 09:13:58 INFO - 'HOME': '/home/cltbld', 09:13:58 INFO - 'LANG': 'en_US.UTF-8', 09:13:58 INFO - 'LANGUAGE': 'en_US:en', 09:13:58 INFO - 'LOGNAME': 'cltbld', 09:13:58 INFO - 'MAIL': '/var/mail/cltbld', 09:13:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:13:58 INFO - 'MOZ_NO_REMOTE': '1', 09:13:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:13:58 INFO - 'NO_EM_RESTART': '1', 09:13:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:13:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:13:58 INFO - 'PWD': '/builds/slave/test', 09:13:58 INFO - 'SHELL': '/bin/bash', 09:13:58 INFO - 'SHLVL': '1', 09:13:58 INFO - 'TERM': 'linux', 09:13:58 INFO - 'TMOUT': '86400', 09:13:58 INFO - 'USER': 'cltbld', 09:13:58 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:13:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:13:58 INFO - '_': '/tools/buildbot/bin/python'} 09:13:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:13:58 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:13: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 09:13: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 09:13: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 09:13: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 09:13: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 09:13: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 09:14:00 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:14:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:14:00 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:14:00 INFO - Installing collected packages: mozsystemmonitor 09:14:00 INFO - Running setup.py install for mozsystemmonitor 09:14:01 INFO - Successfully installed mozsystemmonitor 09:14:01 INFO - Cleaning up... 09:14:01 INFO - Return code: 0 09:14:01 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:14:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:14:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:01 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:14:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:14:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 09:14:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 09:14:01 INFO - Using env: {'DISPLAY': ':0', 09:14:01 INFO - 'HOME': '/home/cltbld', 09:14:01 INFO - 'LANG': 'en_US.UTF-8', 09:14:01 INFO - 'LANGUAGE': 'en_US:en', 09:14:01 INFO - 'LOGNAME': 'cltbld', 09:14:01 INFO - 'MAIL': '/var/mail/cltbld', 09:14:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:01 INFO - 'MOZ_NO_REMOTE': '1', 09:14:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:01 INFO - 'NO_EM_RESTART': '1', 09:14:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:01 INFO - 'PWD': '/builds/slave/test', 09:14:01 INFO - 'SHELL': '/bin/bash', 09:14:01 INFO - 'SHLVL': '1', 09:14:01 INFO - 'TERM': 'linux', 09:14:01 INFO - 'TMOUT': '86400', 09:14:01 INFO - 'USER': 'cltbld', 09:14:01 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:01 INFO - '_': '/tools/buildbot/bin/python'} 09:14:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:14:01 INFO - Downloading/unpacking jsonschema==2.5.1 09:14:01 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 09:14:01 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 09:14:01 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 09:14:01 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 09:14:01 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 09:14:01 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 09:14:03 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:14:03 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:14:03 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 09:14:03 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 09:14:03 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 09:14:03 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 09:14:03 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 09:14:03 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 09:14:03 INFO - Downloading functools32-3.2.3-2.tar.gz 09:14:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:14:03 INFO - warning: no files found matching '*.txt' 09:14:03 INFO - no previously-included directories found matching 'build' 09:14:03 INFO - no previously-included directories found matching 'dist' 09:14:03 INFO - no previously-included directories found matching '.git*' 09:14:03 INFO - Installing collected packages: jsonschema, functools32 09:14:03 INFO - Running setup.py install for functools32 09:14:03 INFO - warning: no files found matching '*.txt' 09:14:03 INFO - no previously-included directories found matching 'build' 09:14:03 INFO - no previously-included directories found matching 'dist' 09:14:03 INFO - no previously-included directories found matching '.git*' 09:14:03 INFO - Successfully installed jsonschema functools32 09:14:03 INFO - Cleaning up... 09:14:03 INFO - Return code: 0 09:14:03 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 09:14:03 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:14:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:03 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:14:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:14:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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', 'functools32==3.2.3-2'] in /builds/slave/test/build 09:14:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 functools32==3.2.3-2 09:14:03 INFO - Using env: {'DISPLAY': ':0', 09:14:03 INFO - 'HOME': '/home/cltbld', 09:14:03 INFO - 'LANG': 'en_US.UTF-8', 09:14:03 INFO - 'LANGUAGE': 'en_US:en', 09:14:03 INFO - 'LOGNAME': 'cltbld', 09:14:03 INFO - 'MAIL': '/var/mail/cltbld', 09:14:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:03 INFO - 'MOZ_NO_REMOTE': '1', 09:14:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:03 INFO - 'NO_EM_RESTART': '1', 09:14:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:03 INFO - 'PWD': '/builds/slave/test', 09:14:03 INFO - 'SHELL': '/bin/bash', 09:14:03 INFO - 'SHLVL': '1', 09:14:03 INFO - 'TERM': 'linux', 09:14:03 INFO - 'TMOUT': '86400', 09:14:03 INFO - 'USER': 'cltbld', 09:14:03 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:03 INFO - '_': '/tools/buildbot/bin/python'} 09:14:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:14:04 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 09:14:04 INFO - Cleaning up... 09:14:04 INFO - Return code: 0 09:14:04 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:14:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:14:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:14:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:04 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:14:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 09:14:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 09:14:04 INFO - Using env: {'DISPLAY': ':0', 09:14:04 INFO - 'HOME': '/home/cltbld', 09:14:04 INFO - 'LANG': 'en_US.UTF-8', 09:14:04 INFO - 'LANGUAGE': 'en_US:en', 09:14:04 INFO - 'LOGNAME': 'cltbld', 09:14:04 INFO - 'MAIL': '/var/mail/cltbld', 09:14:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:04 INFO - 'MOZ_NO_REMOTE': '1', 09:14:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:04 INFO - 'NO_EM_RESTART': '1', 09:14:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:04 INFO - 'PWD': '/builds/slave/test', 09:14:04 INFO - 'SHELL': '/bin/bash', 09:14:04 INFO - 'SHLVL': '1', 09:14:04 INFO - 'TERM': 'linux', 09:14:04 INFO - 'TMOUT': '86400', 09:14:04 INFO - 'USER': 'cltbld', 09:14:04 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:04 INFO - '_': '/tools/buildbot/bin/python'} 09:14:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:14:04 INFO - Downloading/unpacking blobuploader==1.2.4 09:14: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 09:14: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 09:14: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 09:14: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 09:14: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 09:14: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 09:14:06 INFO - Downloading blobuploader-1.2.4.tar.gz 09:14:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:14:06 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:14:06 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 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 09:14:06 INFO - Downloading docopt-0.6.1.tar.gz 09:14:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:14:07 INFO - Installing collected packages: blobuploader, requests, docopt 09:14:07 INFO - Running setup.py install for blobuploader 09:14:07 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:14:07 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:14:07 INFO - Running setup.py install for requests 09:14:07 INFO - Running setup.py install for docopt 09:14:07 INFO - Successfully installed blobuploader requests docopt 09:14:07 INFO - Cleaning up... 09:14:07 INFO - Return code: 0 09:14:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:14:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:14:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:14:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:14:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--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 09:14:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --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 09:14:07 INFO - Using env: {'DISPLAY': ':0', 09:14:07 INFO - 'HOME': '/home/cltbld', 09:14:07 INFO - 'LANG': 'en_US.UTF-8', 09:14:07 INFO - 'LANGUAGE': 'en_US:en', 09:14:07 INFO - 'LOGNAME': 'cltbld', 09:14:07 INFO - 'MAIL': '/var/mail/cltbld', 09:14:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:07 INFO - 'MOZ_NO_REMOTE': '1', 09:14:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:07 INFO - 'NO_EM_RESTART': '1', 09:14:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:07 INFO - 'PWD': '/builds/slave/test', 09:14:07 INFO - 'SHELL': '/bin/bash', 09:14:07 INFO - 'SHLVL': '1', 09:14:07 INFO - 'TERM': 'linux', 09:14:07 INFO - 'TMOUT': '86400', 09:14:07 INFO - 'USER': 'cltbld', 09:14:07 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:07 INFO - '_': '/tools/buildbot/bin/python'} 09:14:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:14:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:14:07 INFO - Running setup.py (path:/tmp/pip-809X_F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:14:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:14:07 INFO - Running setup.py (path:/tmp/pip-CS7Z0L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:14:08 INFO - Running setup.py (path:/tmp/pip-bp64RT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:14:08 INFO - Running setup.py (path:/tmp/pip-8SgUlO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:14:08 INFO - Running setup.py (path:/tmp/pip-vI3z5V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:14:08 INFO - Running setup.py (path:/tmp/pip-7aJYHH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:14:08 INFO - Running setup.py (path:/tmp/pip-qqbgz4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:14:08 INFO - Running setup.py (path:/tmp/pip-u_o99p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:14:08 INFO - Running setup.py (path:/tmp/pip-Jlvlxa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:14:08 INFO - Running setup.py (path:/tmp/pip-CjJZ5J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:14:08 INFO - Running setup.py (path:/tmp/pip-7otM8l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:14:08 INFO - Running setup.py (path:/tmp/pip-Q2s8bt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:14:08 INFO - Running setup.py (path:/tmp/pip-9Czu3H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:14:08 INFO - Running setup.py (path:/tmp/pip-DQZGUu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:14:08 INFO - Running setup.py (path:/tmp/pip-SsRNkp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:14:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:14:08 INFO - Running setup.py (path:/tmp/pip-6lIqGI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:14:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:14:09 INFO - Running setup.py (path:/tmp/pip-bUXzks-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:14:09 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:14:09 INFO - Running setup.py install for manifestparser 09:14:09 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Running setup.py install for mozcrash 09:14:09 INFO - Running setup.py install for mozdebug 09:14:09 INFO - Running setup.py install for mozdevice 09:14:09 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Running setup.py install for mozfile 09:14:09 INFO - Running setup.py install for mozhttpd 09:14:09 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Running setup.py install for mozinfo 09:14:09 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Running setup.py install for mozInstall 09:14:09 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:14:09 INFO - Running setup.py install for mozleak 09:14:09 INFO - Running setup.py install for mozlog 09:14:10 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:14:10 INFO - Running setup.py install for moznetwork 09:14:10 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:14:10 INFO - Running setup.py install for mozprocess 09:14:10 INFO - Running setup.py install for mozprofile 09:14:10 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:14:10 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:14:10 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:14:10 INFO - Running setup.py install for mozrunner 09:14:10 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:14:10 INFO - Running setup.py install for mozscreenshot 09:14:10 INFO - Running setup.py install for moztest 09:14:10 INFO - Running setup.py install for mozversion 09:14:10 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:14:10 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:14:10 INFO - Cleaning up... 09:14:10 INFO - Return code: 0 09:14:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:14:10 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:14:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:10 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:14:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:14:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 09:14:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 09:14:10 INFO - Using env: {'DISPLAY': ':0', 09:14:10 INFO - 'HOME': '/home/cltbld', 09:14:10 INFO - 'LANG': 'en_US.UTF-8', 09:14:10 INFO - 'LANGUAGE': 'en_US:en', 09:14:10 INFO - 'LOGNAME': 'cltbld', 09:14:10 INFO - 'MAIL': '/var/mail/cltbld', 09:14:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:10 INFO - 'MOZ_NO_REMOTE': '1', 09:14:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:10 INFO - 'NO_EM_RESTART': '1', 09:14:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:10 INFO - 'PWD': '/builds/slave/test', 09:14:10 INFO - 'SHELL': '/bin/bash', 09:14:10 INFO - 'SHLVL': '1', 09:14:10 INFO - 'TERM': 'linux', 09:14:10 INFO - 'TMOUT': '86400', 09:14:10 INFO - 'USER': 'cltbld', 09:14:10 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:10 INFO - '_': '/tools/buildbot/bin/python'} 09:14:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:14:11 INFO - Running setup.py (path:/tmp/pip-HRstyC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:14:11 INFO - Running setup.py (path:/tmp/pip-eFtPKQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:14:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:14:11 INFO - Running setup.py (path:/tmp/pip-Kmk91C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:14:11 INFO - Running setup.py (path:/tmp/pip-JjZz3d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:14:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:14:11 INFO - Running setup.py (path:/tmp/pip-LRUdOZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:14:11 INFO - Running setup.py (path:/tmp/pip-v8tcr9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:14:11 INFO - Running setup.py (path:/tmp/pip-2P1dq9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:14:11 INFO - Running setup.py (path:/tmp/pip-nWncSd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:14:11 INFO - Running setup.py (path:/tmp/pip-oBw5kb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:14:11 INFO - Running setup.py (path:/tmp/pip-PCQgGu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:14:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:14:11 INFO - Running setup.py (path:/tmp/pip-sgF7Wx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:14:11 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:14:11 INFO - Running setup.py (path:/tmp/pip-W7r_pt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:14:11 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 09:14:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:14:11 INFO - Running setup.py (path:/tmp/pip-OAz5Ir-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:14:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 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)) 09:14:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:14:12 INFO - Running setup.py (path:/tmp/pip-qI4loE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:14:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 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)) 09:14:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:14:12 INFO - Running setup.py (path:/tmp/pip-KFav6C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:14:12 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)) 09:14:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:14:12 INFO - Running setup.py (path:/tmp/pip-KjhAos-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:14:12 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 09:14:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:14:12 INFO - Running setup.py (path:/tmp/pip-BZ53ch-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:14:12 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)) 09:14:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:14: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==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 09:14:12 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)) 09:14:12 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:14:12 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 09:14:12 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:14:12 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 09:14:12 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 09:14:12 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 09:14:12 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 09:14:12 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 09:14:12 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 09:14:14 INFO - Downloading blessings-1.6.tar.gz 09:14:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:14:14 INFO - Installing collected packages: blessings 09:14:14 INFO - Running setup.py install for blessings 09:14:14 INFO - Successfully installed blessings 09:14:14 INFO - Cleaning up... 09:14:14 INFO - Return code: 0 09:14:14 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:14:14 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:14:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:14:14 INFO - Reading from file tmpfile_stdout 09:14:14 INFO - Current package versions: 09:14:14 INFO - argparse == 1.2.1 09:14:14 INFO - blessings == 1.6 09:14:14 INFO - blobuploader == 1.2.4 09:14:14 INFO - docopt == 0.6.1 09:14:14 INFO - functools32 == 3.2.3-2 09:14:14 INFO - jsonschema == 2.5.1 09:14:14 INFO - manifestparser == 1.1 09:14:14 INFO - mozInstall == 1.12 09:14:14 INFO - mozcrash == 1.0 09:14:14 INFO - mozdebug == 0.1 09:14:14 INFO - mozdevice == 0.49 09:14:14 INFO - mozfile == 1.2 09:14:14 INFO - mozhttpd == 0.7 09:14:14 INFO - mozinfo == 0.9 09:14:14 INFO - mozleak == 0.1 09:14:14 INFO - mozlog == 3.4 09:14:14 INFO - moznetwork == 0.27 09:14:14 INFO - mozprocess == 0.24 09:14:14 INFO - mozprofile == 0.28 09:14:14 INFO - mozrunner == 6.13 09:14:14 INFO - mozscreenshot == 0.1 09:14:14 INFO - mozsystemmonitor == 0.3 09:14:14 INFO - moztest == 0.8 09:14:14 INFO - mozversion == 1.4 09:14:14 INFO - psutil == 3.1.1 09:14:14 INFO - requests == 1.2.3 09:14:14 INFO - wsgiref == 0.1.2 09:14:14 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:14:14 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:14:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:14 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:14:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:14 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--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 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:14:14 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--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 09:14:14 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --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 09:14:14 INFO - Using env: {'DISPLAY': ':0', 09:14:14 INFO - 'HOME': '/home/cltbld', 09:14:14 INFO - 'LANG': 'en_US.UTF-8', 09:14:14 INFO - 'LANGUAGE': 'en_US:en', 09:14:14 INFO - 'LOGNAME': 'cltbld', 09:14:14 INFO - 'MAIL': '/var/mail/cltbld', 09:14:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:14 INFO - 'MOZ_NO_REMOTE': '1', 09:14:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:14 INFO - 'NO_EM_RESTART': '1', 09:14:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:14 INFO - 'PWD': '/builds/slave/test', 09:14:14 INFO - 'SHELL': '/bin/bash', 09:14:14 INFO - 'SHLVL': '1', 09:14:14 INFO - 'TERM': 'linux', 09:14:14 INFO - 'TMOUT': '86400', 09:14:14 INFO - 'USER': 'cltbld', 09:14:14 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:14 INFO - '_': '/tools/buildbot/bin/python'} 09:14:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:14:15 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 09:14:15 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 2)) 09:14:15 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 3)) 09:14:15 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 4)) 09:14:15 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 5)) 09:14:15 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 6)) 09:14:15 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 7)) 09:14:15 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 8)) 09:14:15 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 9)) 09:14:15 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.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 09:14:15 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 4)) 09:14:15 INFO - Cleaning up... 09:14:15 INFO - Return code: 0 09:14:15 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:14:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:14:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:14:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:14:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x146f1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x163ca80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x17e1a30>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, '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': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', '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 09:14:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 09:14:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 09:14:15 INFO - Using env: {'DISPLAY': ':0', 09:14:15 INFO - 'HOME': '/home/cltbld', 09:14:15 INFO - 'LANG': 'en_US.UTF-8', 09:14:15 INFO - 'LANGUAGE': 'en_US:en', 09:14:15 INFO - 'LOGNAME': 'cltbld', 09:14:15 INFO - 'MAIL': '/var/mail/cltbld', 09:14:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:15 INFO - 'MOZ_NO_REMOTE': '1', 09:14:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:15 INFO - 'NO_EM_RESTART': '1', 09:14:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:15 INFO - 'PWD': '/builds/slave/test', 09:14:15 INFO - 'SHELL': '/bin/bash', 09:14:15 INFO - 'SHLVL': '1', 09:14:15 INFO - 'TERM': 'linux', 09:14:15 INFO - 'TMOUT': '86400', 09:14:15 INFO - 'USER': 'cltbld', 09:14:15 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:15 INFO - '_': '/tools/buildbot/bin/python'} 09:14:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:14:15 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:14:15 INFO - Cleaning up... 09:14:15 INFO - Return code: 0 09:14:15 INFO - Running post-action listener: _resource_record_post_action 09:14:15 INFO - Running post-action listener: _start_resource_monitoring 09:14:15 INFO - Starting resource monitoring. 09:14:15 INFO - [mozharness: 2017-03-05 17:14:15.344250Z] Finished create-virtualenv step (success) 09:14:15 INFO - [mozharness: 2017-03-05 17:14:15.344740Z] Running install step. 09:14:15 INFO - Running pre-action listener: _resource_record_pre_action 09:14:15 INFO - Running main action method: install 09:14:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:14:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:14:15 INFO - Reading from file tmpfile_stdout 09:14:15 INFO - Detecting whether we're running mozinstall >=1.0... 09:14:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:14:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:14:15 INFO - Reading from file tmpfile_stdout 09:14:15 INFO - Output received: 09:14:15 INFO - Usage: mozinstall [options] installer 09:14:15 INFO - Options: 09:14:15 INFO - -h, --help show this help message and exit 09:14:15 INFO - -d DEST, --destination=DEST 09:14:15 INFO - Directory to install application into. [default: 09:14:15 INFO - "/builds/slave/test"] 09:14:15 INFO - --app=APP Application being installed. [default: firefox] 09:14:15 INFO - mkdir: /builds/slave/test/build/application 09:14:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 09:14:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 09:14:32 INFO - Reading from file tmpfile_stdout 09:14:32 INFO - Output received: 09:14:32 INFO - /builds/slave/test/build/application/firefox/firefox 09:14:32 INFO - Running post-action listener: _resource_record_post_action 09:14:32 INFO - [mozharness: 2017-03-05 17:14:32.120190Z] Finished install step (success) 09:14:32 INFO - [mozharness: 2017-03-05 17:14:32.120341Z] Running run-tests step. 09:14:32 INFO - Running pre-action listener: _resource_record_pre_action 09:14:32 INFO - Running main action method: run_tests 09:14:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:14:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:14:32 INFO - Python 2.7.3 09:14:32 INFO - Return code: 0 09:14:32 INFO - grabbing minidump binary from tooltool 09:14:32 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 09:14:32 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: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17ded20>, '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 0x17dfab0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x17dff60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:14:32 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 09:14:32 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 09:14:32 INFO - Calling ['/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'] with output_timeout 600 09:14:32 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:14:32 INFO - Return code: 0 09:14:32 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:14:32 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:14:32 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:14:32 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:14:32 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:14:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-080', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 09:14:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-080 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 09:14:32 INFO - Using env: {'DISPLAY': ':0', 09:14:32 INFO - 'HOME': '/home/cltbld', 09:14:32 INFO - 'LANG': 'en_US.UTF-8', 09:14:32 INFO - 'LANGUAGE': 'en_US:en', 09:14:32 INFO - 'LOGNAME': 'cltbld', 09:14:32 INFO - 'MAIL': '/var/mail/cltbld', 09:14:32 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:14:32 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:14:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:14:32 INFO - 'MOZ_NO_REMOTE': '1', 09:14:32 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:14:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:14:32 INFO - 'NO_EM_RESTART': '1', 09:14:32 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:14:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:14:32 INFO - 'PWD': '/builds/slave/test', 09:14:32 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:14:32 INFO - 'SHELL': '/bin/bash', 09:14:32 INFO - 'SHLVL': '1', 09:14:32 INFO - 'TERM': 'linux', 09:14:32 INFO - 'TMOUT': '86400', 09:14:32 INFO - 'USER': 'cltbld', 09:14:32 INFO - 'XDG_SESSION_COOKIE': '781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874', 09:14:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:14:32 INFO - '_': '/tools/buildbot/bin/python'} 09:14:32 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-080', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 09:14:32 INFO - mozversion application_buildid: 20170305162304 09:14:32 INFO - mozversion application_changeset: 4b6a130cc3424f17b07220bd23c2c70c4f32e860 09:14:32 INFO - mozversion application_display_name: FirefoxDeveloperEdition 09:14:32 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:14:32 INFO - mozversion application_name: Firefox 09:14:32 INFO - mozversion application_remotingname: firefox-dev 09:14:32 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 09:14:32 INFO - mozversion application_vendor: Mozilla 09:14:32 INFO - mozversion application_version: 53.0a2 09:14:32 INFO - mozversion platform_buildid: 20170305162304 09:14:32 INFO - mozversion platform_changeset: 4b6a130cc3424f17b07220bd23c2c70c4f32e860 09:14:32 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 09:14:32 INFO - mozversion platform_version: 53.0a2 09:14:32 INFO - using testdate: 1488734072 09:14:32 INFO - actual date: 1488734072 09:14:32 INFO - starting webserver on 'localhost:47452' 09:14:32 INFO - SUITE-START | Running 2 tests 09:14:32 INFO - TEST-START | dromaeo_css 09:14:32 INFO - operating with platform_type : linux_ 09:14:32 INFO - Initialising browser for dromaeo_css test... 09:14:32 INFO - TEST-INFO | started process 24280 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphC06sZ/profile http://localhost:47452/getInfo.html) 09:14:36 INFO - PROCESS | 24280 | __metrics Screen width/height:1600/1200 09:14:36 INFO - PROCESS | 24280 | colorDepth:24 09:14:36 INFO - PROCESS | 24280 | Browser inner width/height: 1024/697 09:14:36 INFO - PROCESS | 24280 | __metrics 09:14:37 INFO - PROCESS | 24280 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 09:14:37 INFO - PROCESS | 24280 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:14:38 INFO - TEST-INFO | 24280: exit 0 09:14:38 INFO - Browser initialized. 09:14:38 INFO - Running cycle 1/1 for dromaeo_css test... 09:14:38 INFO - TEST-INFO | started process 24371 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmphC06sZ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:14:50 INFO - PROCESS | 24371 | RSS: Main: 138055680 09:14:50 INFO - PROCESS | 24371 | 09:17:50 INFO - PROCESS | 24371 | Cycle 1(1): loaded http://localhost:47452/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47452/tests/dromaeo/cssquery-ext.html) 09:17:51 INFO - PROCESS | 24371 | RSS: Main: 240893952 09:17:51 INFO - PROCESS | 24371 | 09:19:40 INFO - PROCESS | 24371 | ************************* 09:19:40 INFO - PROCESS | 24371 | A coding exception was thrown and uncaught in a Task. 09:19:40 INFO - PROCESS | 24371 | 09:19:40 ERROR - PROCESS | 24371 | Full message: TypeError: NetworkError when attempting to fetch resource. 09:19:40 INFO - PROCESS | 24371 | Full stack: 09:19:40 INFO - PROCESS | 24371 | ************************* 09:20:54 INFO - PROCESS | 24371 | Cycle 1(1): loaded http://localhost:47452/tests/dromaeo/cssquery-ext.html (next: http://localhost:47452/tests/dromaeo/cssquery-jquery.html) 09:20:54 INFO - PROCESS | 24371 | RSS: Main: 221986816 09:20:54 INFO - PROCESS | 24371 | 09:23:56 INFO - PROCESS | 24371 | Cycle 1(1): loaded http://localhost:47452/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47452/tests/dromaeo/cssquery-mootools.html) 09:23:57 INFO - PROCESS | 24371 | RSS: Main: 171155456 09:23:57 INFO - PROCESS | 24371 | 09:26:59 INFO - PROCESS | 24371 | Cycle 1(1): loaded http://localhost:47452/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47452/tests/dromaeo/cssquery-prototype.html) 09:26:59 INFO - PROCESS | 24371 | RSS: Main: 214712320 09:26:59 INFO - PROCESS | 24371 | 09:30:02 INFO - PROCESS | 24371 | Cycle 1(1): loaded http://localhost:47452/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47452/tests/dromaeo/cssquery-yui.html) 09:30:02 INFO - PROCESS | 24371 | RSS: Main: 171859968 09:30:02 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | Cycle 1(1): loaded http://localhost:47452/tests/dromaeo/cssquery-yui.html (next: http://localhost:47452/tests/dromaeo/cssquery-dojo.html) 09:33:05 INFO - PROCESS | 24371 | RSS: Main: 244727808 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | __start_tp_report 09:33:05 INFO - PROCESS | 24371 | _x_x_mozilla_page_load 09:33:05 INFO - PROCESS | 24371 | _x_x_mozilla_page_load_details 09:33:05 INFO - PROCESS | 24371 | |i|pagename|runs| 09:33:05 INFO - PROCESS | 24371 | |0;dojo.html;3268.5750852389187;3277.770556061076;3305.7024867761897;3333.783304085233;3345.983270083649;5346.091164502034;5403.243545903567;5405.756740946657;5416.783328666848;5433.673979561219;5378.1663842104535;5413.106837371839;5428.158635411518;5430.83707488775;5436.836894893149;4917.21324588066;4938.678985865925;4998.325226094467;5012.072766538184;5024.145895197807;4885.487023862496;5006.299118123466;5064.341635587369;5067.163917953533;5094.184930411135;4870.025994801036;4932.309476673268;4952.653314268003;4956.975215123919;5035.571976381993;4993;5031.32077169581;5033.597312215014;5037.748112594392;5067.61992850534;4966.404031516205;4983.377077865267;5004.074246264417;5012.649114561982;5024.824131155428;5231;5353.357597088336;5405.054115529767;5473.863153421156;5478.671279723229;5821.912671309891;5828.1549175369755;5835.183074369592;5846.619969701956;5872.970635146797;5834.0373838317055;5873.412658734135;5882.735276912549;5894.440028197358;5918.792842250544;5310.150375939869;5390.353157621072;5402.621816472888;5430.321209848769;5505.642133261325;5880.647161170344;5898.1152827076285;5909.349971503131;5932.584719069624;5949.25634295713;5704.22992895962;5706.343770466449;5710.65736055838;5713.114467257582;5726.742296596663;5618.4662457066515;5671.319441667027;5725.828225153252;5746.540276777848;5796.88406231873;5739.942600573941;5749.367569567345;5808.983427900101;5839.941600584025;5843.1235314703135;5803.245578074823;5806.419358064244;5808.883822323614;5811.564132690065;5828.242328497268;4396.868093957187;4436.179306828247;4488.438945131858;4501.144782491317;4506.864794056183;3993.940090898639;4034.4755181826176;4038.676905847525;4042.555318914917;4078.5921407858978;5592.804251851166;5604.523615492729;5609.887802243932;5612.158176273591;5635.605507614428;5636.605437619327;5670.659760414306;5801.3038435388025;5867.911981320283;5897.351291357947;5596.356419011784;5639.125935480007;5657.094864821609;5660;5691.03252447085;5037.82367617139;5042.949570504248;5048.217526283432;5058.620603454682;5071.5689166420525;5895.9999999999145;5903.645781253139;6091.695415229221;6132.816015519542;6155.076738489262;5783.19035335045;5818.970905145447;5819.330776960704;5874.383189765013;5899.705014749331;6057.273127224761;6064.696765161812;6065.5754097212775;6065.757369705162;6072.423119803611;5565.6104072714525;5716.228309178207;5755.1367294906095;5774.624649397776;5779.595428319977;5702.942970570241;5714.571407144564;5786.103154011135;5795.94204057954;5874.353821079592;5616.943830561642;5676.602637815313;5677.971610141923;5680.091185410314;5692.1461780733225;5655.660660360391;5662.235598194191;5691.658500489818;5695.202671625892;5695.971520142372;5480.725963701879;5497.147942068986;5519.3652729936575;5526.22632831412;5529.778808847601;5609.1305847593685;5610.5231055360755;5623.718814059363;5625.043742563692;5650.463205995424;5503.917441238465;5506.339239291311;5507.146392309199;5511.366192887869;5512.972435137799 09:33:05 INFO - PROCESS | 24371 | |1;ext.html;550.1343236409608;590.1236663554622;618.8983609175667;619.3187493756865;648.5233353485185;36562;47709.04581908364;48469.757651211694;48575;48590.999999999956;50480.49519504804;50995.745021274844;51030.74484627581;51101.48898511014;51183.744081279634;8825.691100811473;9403.294752893544;9572;9583.424994500318;9588.95205523975;8754.474731516098;10939.945300273488;11144.052755515791;11152.275102118378;11601.477933492972;11281.097512199045;11347.148963827705;11359.318440893532;11361.602343917964;11363.886361136365;11360.204785665006;11405.885941140565;11408.315501069963;11415.771684566304;11430.37132957687;11373.772524549546;11398.487068081957;11403.828942565786;11450.42747862612;11451.312921224753;48670.75664621654;48856.26715599269;49071;49104.75447622775;49171.2624310632;4344.218040752663;4485.237509623372;4494.438195225597;4500.302453119772;4668.043051174535;32039.359212815612;32214.355712885612;32219.19452013695;32591.348173036407;33355;4430.534793846664;4430.689851710382;4437.64498840092;4463.330500424962;4488.035072459405;361095;362939;362999;364308.9999999973;364698;61932.38067619356;61933.07100393498;62139;62267;62418.687906561085;65441.672791635734;65477;65556;65568;65683;17963.371282005068;18418.907905460386;18421.355252566096;18425.26298948054;18446.631067378577;13548.59354219375;13757;13893.096948698303;13903.582892513241;14274.286285685881;18765.155567999474;19158.904205478884;19268;19426.611467770566;19478;7377.483576149725;7405.407567394595;7494.962525187449;7539.849203015909;7621.618919054025;938.4603852784676;960.7213907966611;966.5553845231273;969.9612015519441;970.0154343341515;31076;32142.35715285728;32742.50886236708;32856;33694.98915032553;992.9304948653669;1135.4266095621824;1148.615213903335;1163.4589915689075;1177.7821103095955;16650.16749162537;17709;17795.644087118184;17851.28594856217;17948.37180698669;150675.24662376838;151822;152143;152195;152883.23558382137;67859;68210.65894670594;68428.6578567104;68573;68665.65667171632;1503.4888138032902;1523.474401331539;1538.8999715018713;1544.2819089123611;1576.1961399686243;29602;31336.809883239664;31435.685643143275;31586.210344741565;31961.6803831968;55844.72077639586;56315.71842140763;56317.71841140768;56407.43592564022;56570.717146414005;330988;331082;332067;332421;332832;28400.85799570989;28931.855340723163;29949;30633.693663063084;31600.841995789873;45377.546224537335;52589.474105259986;52980.470195299094;53038;53076;43117;43557;44123.33814992842;44784;46180.769096154305;42986.14027719491;44365.1804670913;44466.3330050043;45493.31760023668;46081;43101.78449107734;43644.127117458105;44249.33625995677;44816;45208.32187517256;35736.642633573334;39019.6098039016;39170.80414597909;39355.38253587493;39513.60486395099;28676.569851452663;28777.071845280672;28966.7103328964;29203.269918252212;29231 09:33:05 INFO - PROCESS | 24371 | |2;jquery.html;419.68942982193147;428.0813453420201;435.7320248047451;440.37466797148045;440.76419115773047;20419.99999999998;21191.152353905843;21428.357149285548;21537.353879383645;21756.347309580717;22233.333000009985;22936.65595016072;23089.653655195143;23203.883980580114;23583;5965.46310832025;6116.81649550512;6175.104609831572;6176;6183.752649893999;6054.96972515139;6267.843303917393;6307.022411526221;6352.587081839689;6365;6366.108744775735;6372.139761132257;6383.042543618448;6517.837054073662;6944.652767361637;7055.541389809671;7060.894086588705;7076.646167691595;7091.113610798624;7093.219745827955;6121.234845644294;6261.749530018794;6266.968665156645;6298.590591611531;6309.810705678837;14771.482998095014;14790.70418591633;14839.629009274855;14894.925525372411;14995.250237488082;2814.8170368926158;3112.1908303840937;3124.297033167519;3130.311331507065;3177.507486339598;10370.533326000348;10455.68632941013;10590;10679.786404271948;11128.944355278252;1998.1707591349573;2022.7269318641943;2119.8728076315315;2125.6280150973516;2128.053016407699;86232;95776;97442.51278743632;99681;100714.49642751813;11167;11229.10167186623;11297.887021129847;11389.829152562717;11603;16162.35350585987;16184.676306473804;16193.190340483165;16201;16221.67556648884;8474.322054235647;8951.955240223757;8981.865272020925;9164.312676549152;9175.403598766059;8803.207711305886;8870.201681848535;8886.777830554158;9072.81854362909;9119;4725.64557658177;4728.95271047292;4777.092352453023;4828.806847726122;4847.151748444008;2054.3220737156703;2077.6987336836073;2102.821260192901;2169.631162702313;2172.3048624440344;868.5874209750318;881.5239770523973;893.6738090596886;903.7514683461969;910.4491782471641;20303.695444568344;21114.261000864895;21170.082343539718;21192.36422907315;21247.36257912265;910.0580898769741;913.0960349254191;920.0845159066771;930.7533503621411;939.2626787971546;11475.426228688531;11546.134039947037;11642.126840486997;11717.765644687059;11787.35169565665;725403;738104;757421;757681;763180;83634.29119923094;90196.5490172545;98984.5050774756;109700;114263.42868285606;1103.2663278919429;1150.3500522204927;1163.1215586827213;1172.724409763722;1175.1538891997748;19264.422067338;19641;19740.30908918181;19917.30289439863;19972.20111195536;49099.754501228694;49164;49559.256611151584;49984.500154997986;50950.74524627353;71785.28214717995;71815;72220;72578.63710681624;73301;8285.25432711059;8518.190771876662;8708.738737837875;8870.556472176237;9430.245580353418;10347.43089130105;13716.245606491739;14647.853521464649;14980.925095374454;15122.017068890487;9728.562214700498;10004.399736015863;12240.326782027074;12286.877131228573;12423.937880310541;8304.418690691835;12560.057995650546;12719.236845789283;12790.232586044867;12923.289219092663;8169.754907352789;10688.786224275316;12162.209456385306;12604.495820167458;12737.617871463872;8342.582870856311;8518.957405212934;8607.440516366416;8670.869936950825;8734.82530349402;12320.260784352968;12773.297468639314;12952.676183095122;12965.15726477776;12986.285754283605 09:33:05 INFO - PROCESS | 24371 | |3;mootools.html;1455.3232746772749;1490.6646004648956;1511.3954418232706;1519.4757808556049;1540.2760702469843;8008.919910800891;8479.406441549094;8479.830403391928;8500;8502.829943401128;7238.384737297336;7416.110066791979;7955.92044079559;8186.181381861811;8349.123342049088;2212.7344718633785;2251.34710933829;2252.831037672173;2254.211026140854;2262.7850354216407;2205.514786746913;2228;2245.461089338555;2246.550689862026;2247.045005872506;2125.2455378340696;2127.755308139568;2150.602138604363;2151.1610471915965;2180.0843645668856;2152.547964927367;2164.9242276520326;2172.283146561647;2175.749788774295;2177.923772667957;2127.2022991378235;2167.8590891592153;2170.4248374180856;2172.9565408691897;2175.673648952654;8347.457415268049;8411.411201215917;8422.368322375847;8429.735539669038;8433.831323373559;5106.821261255838;5197.8440646780655;5212.478752124757;5214.478552144755;5234.659747116425;3153.9743212780463;3271.2312606537444;3287.211069343364;3305.2563173286057;3305.93388132236;1190.7618476304688;1283.5507572349695;1316.776148054833;1329.9401526931215;1407.0713329202779;11481.770364592745;11516.654500365003;11521.654350369503;11528.308301501853;11548.24936379141;4210.789460526961;4501.977490112594;4575.405197324393;4657.183698357643;4672.883177920511;9861.112499875046;9871.703848884545;9872.111509964137;9873.50632468388;9882.308238423242;5131.948680513222;5148.9485105149215;5151.562117220078;5152.27868098459;5152.381714194245;4033.5361433434946;4135.359019352005;4645.117427688729;4734.810607575659;4818.084563932912;3928.744631598937;3964.048628329238;4007.519097708294;4033.91932161361;4039.434479172918;1249.2192379762648;1263.8293830332786;1264.4246867675186;1265.6329664397406;1268.4165283969478;924.6948506992676;930.1582068228264;935.4527601353149;943.6319835264252;943.9056094390643;5262.657927234717;5848.327442344185;5849.970750146307;5911.556633252523;6113.174721412642;997.5261750668375;1021.6973358967376;1027.9794404111876;1044.5821671331528;1049.6536143072767;3453.3438646657055;3508.438649816017;3607;3632.3461776880417;3641.5266015418356;9831.066048725359;9978.750531236778;10061.69814905554;10071.496425178711;10239.795204095877;9912.405255684538;9978.401295922124;10012.799744005224;10014.29899907014;10024.097831195228;7538.547687138789;7717.807054823562;7724.884126738103;7731.690732370755;7805.531668099932;5061.0933438440225;5107.155974230931;5148.014151791876;5201.843944681666;5207.505286997729;9026.503542304974;9050.502222377832;9054.81890362176;9062.546872656472;9148.359614826899;8920.375573709778;9088.727338179866;9140.314476414163;9143.63425462974;9201.907980920105;6272.74909003653;6306.148669929685;6830.624315662686;6970.093887794555;7087.14954205478;8299.336053115616;8366.03790564093;8367.707130250412;8372.665093396196;8384.580770961305;7291.234420385783;7355;7396.3343299103335;7397.852042959218;7463.888041679271;7054;7061.6469176542;7079.362857342864;7091.361777440055;7127.465440092117;6453.677316134268;6549.901751473636;6557.606543607399;6557.868842623217;6561.835954101186;4803.303520989367;4943.77753001123;4987.226979818134;5006.349174607278;5064.366954130734;5021.648484606042;5027;5165.483451654804;5170.844874653616;5209.166533354645 09:33:05 INFO - PROCESS | 24371 | |4;prototype.html;383.82344121704034;401.8493065100588;402.41247778243763;404.04241946586575;405.85389259866463;5398.757055932482;5410.4319046500095;5414.269073675053;5425.593080518957;5431.83704488865;5094.694318340902;5177.922331165026;5258.789648414059;5301.575873930086;5329.280547126137;4266.501468795589;4285.378620100076;4305.354196870463;4339.414179085815;4349.238883195444;4268.231718290706;4290.4636920384955;4298.505671847746;4308.719933204332;4317.503487098977;4069;4106.733062350952;4215.304474761676;4286.057067445157;4322.82708691652;4268.65537355732;4269.946987903632;4270.38079478477;4274.722143060707;4281.850135245282;3872.6514613684903;3879.3792993121247;3882.825272862728;3888.494495715539;3889.747166434173;5060.67105638136;5175.585953123741;5193;5261.842144735664;5268.631195816256;4872.951270487285;4890.73100979446;4908.7300198489065;4919.532644398776;4923.359963204761;5566.35986861508;5602.859928501779;5610.579206559524;5612.803551875665;5624.5781566382275;3910.648041676263;4022.6781857451333;4053.7973101344814;4273.508546517128;4296.978515107436;5706.743196556124;5721.199032135504;5732.627379220337;5743.770249190027;5757.107648314518;4127.504699436087;4133.379993001014;4142.565030671736;4142.91714165715;4164.125533637909;3979.6816254699556;4096.32410652239;4221.641160501392;4222.451081359465;4224.281872081753;4699.765011749399;4750.714957102516;4757.35775670287;4758.738934182445;4772.969164580447;5588.860278492989;5608.383077861432;5623.184638227434;5625.240592520039;5658.207850900877;1348.6493511686836;1401.53048728675;1416.667083235439;1422.38837299962;1423.8576142385677;961.2262128986233;971.7424882406168;973.5035132082688;978.2223132609593;978.8238117138983;5232.3459567554055;5233.555147812479;5249.448807875118;5275.709835958983;5317.361916570037;5554.750036248379;5558.694271815089;5570.526505247019;5572.637778544382;5584.301962254718;5172.560332371715;5296.655717378435;5326.36083669962;5338.332708411449;5404.567634589223;2933.559966005116;2955.2168675301064;2965.1845742420574;2970.2425881400104;2974.8512574371193;5823.515003674036;5827.202942587497;5842.532597392198;5846.298444186725;5854.4730974212525;5516;5598.21624972496;5612.691301978431;5664.773409063591;5681.659100453986;5729.914051289234;5785;5785.71071446426;5831.70841457917;5831.912521312099;5341.931613677202;5527;5571.9721401392735;5590;5635.436456354331;5511.448855114617;5517.420670829505;5531.557475401878;5581.972090139523;5600.635958662674;5705.572082093777;5748.626339287933;5748.885022299614;5868.94131058684;5895.793647222326;4050.9797451012555;4231.809568569361;4249.617534421917;4253.91492170161;4323.243432399255;5475.508643567087;5642.492175704207;5656.60403771732;5759.280089988752;5771.220885180447;5564.805231816867;5569.220309156641;5578.3584887738425;5620.18507316445;5620.494155525858;5311.707856067799;5552.750126244409;5582.665040097607;5597.888042239214;5601.383847776659;5574.9721251393485;5580.441955804387;5594.468525490072;5597.468240517144;5600.691961942132;5644.4035743558425;5645.294338207724;5655.519280861008;5655.915161272502;5673.234113394639;5260.237265596391;5499.670019798825;5544.564348521248;5546.833594992157;5549.528290095225 09:33:05 INFO - PROCESS | 24371 | |5;yui.html;742.5507567921404;757.9621018949051;778.8130848596335;821.3757544266358;821.7781199076247;16011.839881601196;17228.741568876478;17283;17334.219960101793;17366.218520166592;15386.153761543139;15615.531534053996;15646.530604081867;15648.217589120555;15658.060516369025;680.6120511308557;697.7941507255372;808.5593351623379;816.1715858403725;824.8350329934008;834.8580741273998;836.017679226909;837.2088376484224;837.4598384042289;837.7570504553703;880.4409200157913;886.264400547544;887.4409122252972;887.6937456577471;888.0542222533014;741.6921977379382;751.6842925971105;851.9148085191493;868.8827008353854;881.8633111867671;641.3586413586413;642.3640595810115;642.4507046475243;642.752540271994;643.0450780590819;15304.311305991147;15388.076715397001;15402;15438.5368438947;15684.76472852908;14437.350319235555;14973.326200321011;15314.463993760277;15495.767563486557;15515;14071.71856562863;14096.224707641075;14144.646383840487;14342.64143396413;14366.425342986267;3928.3125453045886;3948.7630742155275;3979.204159168149;4078.3882417637296;4575.725456472623;83444.58277708634;84173.57913210455;84532;86353.99999999937;87020.56489717575;11676.182667213214;11728.179027467995;11741.447139086666;11843.940780296043;11961.641150765317;22290.554188916132;22379;22663.093476261096;22674.639521628425;22714.43213919632;8218.958905205436;8283.37874659391;8428.115047920002;8510.532739305916;8663.566821658891;4353.390525326457;4509.661775366861;4667.159911216014;4866.172750632401;4890.731009794425;3641.2717456508276;3769.359208934488;3772.5284339457567;3773.52830896138;3774.6602805747616;617.4381313005233;619.6746707978257;632.6678493790797;644.2365796531126;644.4940721533574;665.6638397609273;704.7779949315949;707.8088915992653;750.8385697075155;832.6128350317132;10094.899051009543;11060.17048721333;11398.658040258806;11422.828657570142;11699.181057326075;614;618.42486487567;619.278540500312;622.3620788691537;651.4299987510927;5237.376413311886;5302.522772950453;5350.5184533392185;5352;5379.811706590329;69517.65241173863;78058;79395.20604793879;79581.60209198917;80284.59857700791;71500.64249678719;72215;72225.6388718053;72880.63559682168;73757.26242737504;65313.67343163254;65542;66187.33812661908;66584.33415665878;67601;9521.904780952378;9821.75661585803;9846.31075824714;9879.20966322678;9887.604495820087;43325.58278185158;43516.78241608771;43667.56332436635;44182.77908610436;44888.32667510055;53950.73024635009;54958.45041549533;55671.72164139153;55956;56844.71577642085;12459.314737689514;12793.61619151427;12909.559698532403;12975.935120324339;13049.37791213958;12891.226526408445;13017.739645206853;13095.67260818449;13281.269530175932;13353.732925341244;11618.76762464763;12179.634610961686;13442.865571344162;13656.726865462437;13735.313234338044;13311.267880266678;13668.863311367157;13828.585142445743;13937.790933135808;14362.856371436152;13408.731825363244;13503.662408439475;13508.189508629514;13612;13875.306234688427;11178.217524773188;11423.485943132413;11524.94237528807;11525.827112593486;11801;11017.61438349686;11726.355050472306;12489.250644961332;12776.169548979658;13106.672333191365 09:33:05 INFO - PROCESS | 24371 | __end_tp_report 09:33:05 INFO - PROCESS | 24371 | __start_cc_report 09:33:05 INFO - PROCESS | 24371 | _x_x_mozilla_cycle_collect,908 09:33:05 INFO - PROCESS | 24371 | __end_cc_report 09:33:05 INFO - PROCESS | 24371 | __startTimestamp1488735185740__endTimestamp 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | ------- Summary: start ------- 09:33:05 INFO - PROCESS | 24371 | Number of tests: 6 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | [#0] dojo.html Cycles:165 Average:5411.68 Median:5612.16 stddev:581.37 (10.4%) stddev-sans-first:558.32 09:33:05 INFO - PROCESS | 24371 | Values: 3268.6 3277.8 3305.7 3333.8 3346.0 5346.1 5403.2 5405.8 5416.8 5433.7 5378.2 5413.1 5428.2 5430.8 5436.8 4917.2 4938.7 4998.3 5012.1 5024.1 4885.5 5006.3 5064.3 5067.2 5094.2 4870.0 4932.3 4952.7 4957.0 5035.6 4993.0 5031.3 5033.6 5037.7 5067.6 4966.4 4983.4 5004.1 5012.6 5024.8 5231.0 5353.4 5405.1 5473.9 5478.7 5821.9 5828.2 5835.2 5846.6 5873.0 5834.0 5873.4 5882.7 5894.4 5918.8 5310.2 5390.4 5402.6 5430.3 5505.6 5880.6 5898.1 5909.3 5932.6 5949.3 5704.2 5706.3 5710.7 5713.1 5726.7 5618.5 5671.3 5725.8 5746.5 5796.9 5739.9 5749.4 5809.0 5839.9 5843.1 5803.2 5806.4 5808.9 5811.6 5828.2 4396.9 4436.2 4488.4 4501.1 4506.9 3993.9 4034.5 4038.7 4042.6 4078.6 5592.8 5604.5 5609.9 5612.2 5635.6 5636.6 5670.7 5801.3 5867.9 5897.4 5596.4 5639.1 5657.1 5660.0 5691.0 5037.8 5042.9 5048.2 5058.6 5071.6 5896.0 5903.6 6091.7 6132.8 6155.1 5783.2 5819.0 5819.3 5874.4 5899.7 6057.3 6064.7 6065.6 6065.8 6072.4 5565.6 5716.2 5755.1 5774.6 5779.6 5702.9 5714.6 5786.1 5795.9 5874.4 5616.9 5676.6 5678.0 5680.1 5692.1 5655.7 5662.2 5691.7 5695.2 5696.0 5480.7 5497.1 5519.4 5526.2 5529.8 5609.1 5610.5 5623.7 5625.0 5650.5 5503.9 5506.3 5507.1 5511.4 5513.0 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | [#1] ext.html Cycles:180 Average:49096.59 Median:39095.21 stddev:78086.26 (199.7%) stddev-sans-first:78220.23 09:33:05 INFO - PROCESS | 24371 | Values: 550.1 590.1 618.9 619.3 648.5 36562.0 47709.0 48469.8 48575.0 48591.0 50480.5 50995.7 51030.7 51101.5 51183.7 8825.7 9403.3 9572.0 9583.4 9589.0 8754.5 10939.9 11144.1 11152.3 11601.5 11281.1 11347.1 11359.3 11361.6 11363.9 11360.2 11405.9 11408.3 11415.8 11430.4 11373.8 11398.5 11403.8 11450.4 11451.3 48670.8 48856.3 49071.0 49104.8 49171.3 4344.2 4485.2 4494.4 4500.3 4668.0 32039.4 32214.4 32219.2 32591.3 33355.0 4430.5 4430.7 4437.6 4463.3 4488.0 361095.0 362939.0 362999.0 364309.0 364698.0 61932.4 61933.1 62139.0 62267.0 62418.7 65441.7 65477.0 65556.0 65568.0 65683.0 17963.4 18418.9 18421.4 18425.3 18446.6 13548.6 13757.0 13893.1 13903.6 14274.3 18765.2 19158.9 19268.0 19426.6 19478.0 7377.5 7405.4 7495.0 7539.8 7621.6 938.5 960.7 966.6 970.0 970.0 31076.0 32142.4 32742.5 32856.0 33695.0 992.9 1135.4 1148.6 1163.5 1177.8 16650.2 17709.0 17795.6 17851.3 17948.4 150675.2 151822.0 152143.0 152195.0 152883.2 67859.0 68210.7 68428.7 68573.0 68665.7 1503.5 1523.5 1538.9 1544.3 1576.2 29602.0 31336.8 31435.7 31586.2 31961.7 55844.7 56315.7 56317.7 56407.4 56570.7 330988.0 331082.0 332067.0 332421.0 332832.0 28400.9 28931.9 29949.0 30633.7 31600.8 45377.5 52589.5 52980.5 53038.0 53076.0 43117.0 43557.0 44123.3 44784.0 46180.8 42986.1 44365.2 44466.3 45493.3 46081.0 43101.8 43644.1 44249.3 44816.0 45208.3 35736.6 39019.6 39170.8 39355.4 39513.6 28676.6 28777.1 28966.7 29203.3 29231.0 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | [#2] jquery.html Cycles:180 Average:37760.65 Median:423.89 stddev:122799.95 (28970.1%) stddev-sans-first:123112.42 09:33:05 INFO - PROCESS | 24371 | Values: 419.7 428.1 435.7 440.4 440.8 20420.0 21191.2 21428.4 21537.4 21756.3 22233.3 22936.7 23089.7 23203.9 23583.0 5965.5 6116.8 6175.1 6176.0 6183.8 6055.0 6267.8 6307.0 6352.6 6365.0 6366.1 6372.1 6383.0 6517.8 6944.7 7055.5 7060.9 7076.6 7091.1 7093.2 6121.2 6261.7 6267.0 6298.6 6309.8 14771.5 14790.7 14839.6 14894.9 14995.3 2814.8 3112.2 3124.3 3130.3 3177.5 10370.5 10455.7 10590.0 10679.8 11128.9 1998.2 2022.7 2119.9 2125.6 2128.1 86232.0 95776.0 97442.5 99681.0 100714.5 11167.0 11229.1 11297.9 11389.8 11603.0 16162.4 16184.7 16193.2 16201.0 16221.7 8474.3 8952.0 8981.9 9164.3 9175.4 8803.2 8870.2 8886.8 9072.8 9119.0 4725.6 4729.0 4777.1 4828.8 4847.2 2054.3 2077.7 2102.8 2169.6 2172.3 868.6 881.5 893.7 903.8 910.4 20303.7 21114.3 21170.1 21192.4 21247.4 910.1 913.1 920.1 930.8 939.3 11475.4 11546.1 11642.1 11717.8 11787.4 725403.0 738104.0 757421.0 757681.0 763180.0 83634.3 90196.5 98984.5 109700.0 114263.4 1103.3 1150.4 1163.1 1172.7 1175.2 19264.4 19641.0 19740.3 19917.3 19972.2 49099.8 49164.0 49559.3 49984.5 50950.7 71785.3 71815.0 72220.0 72578.6 73301.0 8285.3 8518.2 8708.7 8870.6 9430.2 10347.4 13716.2 14647.9 14980.9 15122.0 9728.6 10004.4 12240.3 12286.9 12423.9 8304.4 12560.1 12719.2 12790.2 12923.3 8169.8 10688.8 12162.2 12604.5 12737.6 8342.6 8519.0 8607.4 8670.9 8734.8 12320.3 12773.3 12952.7 12965.2 12986.3 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | [#3] mootools.html Cycles:180 Average:5448.72 Median:5139.98 stddev:3022.63 (58.8%) stddev-sans-first:3016.21 09:33:05 INFO - PROCESS | 24371 | Values: 1455.3 1490.7 1511.4 1519.5 1540.3 8008.9 8479.4 8479.8 8500.0 8502.8 7238.4 7416.1 7955.9 8186.2 8349.1 2212.7 2251.3 2252.8 2254.2 2262.8 2205.5 2228.0 2245.5 2246.6 2247.0 2125.2 2127.8 2150.6 2151.2 2180.1 2152.5 2164.9 2172.3 2175.7 2177.9 2127.2 2167.9 2170.4 2173.0 2175.7 8347.5 8411.4 8422.4 8429.7 8433.8 5106.8 5197.8 5212.5 5214.5 5234.7 3154.0 3271.2 3287.2 3305.3 3305.9 1190.8 1283.6 1316.8 1329.9 1407.1 11481.8 11516.7 11521.7 11528.3 11548.2 4210.8 4502.0 4575.4 4657.2 4672.9 9861.1 9871.7 9872.1 9873.5 9882.3 5131.9 5148.9 5151.6 5152.3 5152.4 4033.5 4135.4 4645.1 4734.8 4818.1 3928.7 3964.0 4007.5 4033.9 4039.4 1249.2 1263.8 1264.4 1265.6 1268.4 924.7 930.2 935.5 943.6 943.9 5262.7 5848.3 5850.0 5911.6 6113.2 997.5 1021.7 1028.0 1044.6 1049.7 3453.3 3508.4 3607.0 3632.3 3641.5 9831.1 9978.8 10061.7 10071.5 10239.8 9912.4 9978.4 10012.8 10014.3 10024.1 7538.5 7717.8 7724.9 7731.7 7805.5 5061.1 5107.2 5148.0 5201.8 5207.5 9026.5 9050.5 9054.8 9062.5 9148.4 8920.4 9088.7 9140.3 9143.6 9201.9 6272.7 6306.1 6830.6 6970.1 7087.1 8299.3 8366.0 8367.7 8372.7 8384.6 7291.2 7355.0 7396.3 7397.9 7463.9 7054.0 7061.6 7079.4 7091.4 7127.5 6453.7 6549.9 6557.6 6557.9 6561.8 4803.3 4943.8 4987.2 5006.3 5064.4 5021.6 5027.0 5165.5 5170.8 5209.2 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | [#4] prototype.html Cycles:180 Average:4709.27 Median:5340.13 stddev:1346.71 (25.2%) stddev-sans-first:1310.77 09:33:05 INFO - PROCESS | 24371 | Values: 383.8 401.8 402.4 404.0 405.9 5398.8 5410.4 5414.3 5425.6 5431.8 5094.7 5177.9 5258.8 5301.6 5329.3 4266.5 4285.4 4305.4 4339.4 4349.2 4268.2 4290.5 4298.5 4308.7 4317.5 4069.0 4106.7 4215.3 4286.1 4322.8 4268.7 4269.9 4270.4 4274.7 4281.9 3872.7 3879.4 3882.8 3888.5 3889.7 5060.7 5175.6 5193.0 5261.8 5268.6 4873.0 4890.7 4908.7 4919.5 4923.4 5566.4 5602.9 5610.6 5612.8 5624.6 3910.6 4022.7 4053.8 4273.5 4297.0 5706.7 5721.2 5732.6 5743.8 5757.1 4127.5 4133.4 4142.6 4142.9 4164.1 3979.7 4096.3 4221.6 4222.5 4224.3 4699.8 4750.7 4757.4 4758.7 4773.0 5588.9 5608.4 5623.2 5625.2 5658.2 1348.6 1401.5 1416.7 1422.4 1423.9 961.2 971.7 973.5 978.2 978.8 5232.3 5233.6 5249.4 5275.7 5317.4 5554.8 5558.7 5570.5 5572.6 5584.3 5172.6 5296.7 5326.4 5338.3 5404.6 2933.6 2955.2 2965.2 2970.2 2974.9 5823.5 5827.2 5842.5 5846.3 5854.5 5516.0 5598.2 5612.7 5664.8 5681.7 5729.9 5785.0 5785.7 5831.7 5831.9 5341.9 5527.0 5572.0 5590.0 5635.4 5511.4 5517.4 5531.6 5582.0 5600.6 5705.6 5748.6 5748.9 5868.9 5895.8 4051.0 4231.8 4249.6 4253.9 4323.2 5475.5 5642.5 5656.6 5759.3 5771.2 5564.8 5569.2 5578.4 5620.2 5620.5 5311.7 5552.8 5582.7 5597.9 5601.4 5575.0 5580.4 5594.5 5597.5 5600.7 5644.4 5645.3 5655.5 5655.9 5673.2 5260.2 5499.7 5544.6 5546.8 5549.5 09:33:05 INFO - PROCESS | 24371 | 09:33:05 INFO - PROCESS | 24371 | [#5] yui.html Cycles:180 Average:18230.62 Median:4542.69 stddev:23235.74 (511.5%) stddev-sans-first:23263.82 09:33:05 INFO - PROCESS | 24371 | Values: 742.6 758.0 778.8 821.4 821.8 16011.8 17228.7 17283.0 17334.2 17366.2 15386.2 15615.5 15646.5 15648.2 15658.1 680.6 697.8 808.6 816.2 824.8 834.9 836.0 837.2 837.5 837.8 880.4 886.3 887.4 887.7 888.1 741.7 751.7 851.9 868.9 881.9 641.4 642.4 642.5 642.8 643.0 15304.3 15388.1 15402.0 15438.5 15684.8 14437.4 14973.3 15314.5 15495.8 15515.0 14071.7 14096.2 14144.6 14342.6 14366.4 3928.3 3948.8 3979.2 4078.4 4575.7 83444.6 84173.6 84532.0 86354.0 87020.6 11676.2 11728.2 11741.4 11843.9 11961.6 22290.6 22379.0 22663.1 22674.6 22714.4 8219.0 8283.4 8428.1 8510.5 8663.6 4353.4 4509.7 4667.2 4866.2 4890.7 3641.3 3769.4 3772.5 3773.5 3774.7 617.4 619.7 632.7 644.2 644.5 665.7 704.8 707.8 750.8 832.6 10094.9 11060.2 11398.7 11422.8 11699.2 614.0 618.4 619.3 622.4 651.4 5237.4 5302.5 5350.5 5352.0 5379.8 69517.7 78058.0 79395.2 79581.6 80284.6 71500.6 72215.0 72225.6 72880.6 73757.3 65313.7 65542.0 66187.3 66584.3 67601.0 9521.9 9821.8 9846.3 9879.2 9887.6 43325.6 43516.8 43667.6 44182.8 44888.3 53950.7 54958.5 55671.7 55956.0 56844.7 12459.3 12793.6 12909.6 12975.9 13049.4 12891.2 13017.7 13095.7 13281.3 13353.7 11618.8 12179.6 13442.9 13656.7 13735.3 13311.3 13668.9 13828.6 13937.8 14362.9 13408.7 13503.7 13508.2 13612.0 13875.3 11178.2 11423.5 11524.9 11525.8 11801.0 11017.6 11726.4 12489.3 12776.2 13106.7 09:33:05 INFO - PROCESS | 24371 | -------- Summary: end -------- 09:33:05 INFO - PROCESS | 24371 | 09:33:06 INFO - TEST-INFO | 24371: exit 0 09:33:06 INFO - TEST-OK | dromaeo_css | took 1114148ms 09:33:06 INFO - TEST-START | kraken 09:33:06 INFO - operating with platform_type : linux_ 09:33:06 INFO - Initialising browser for kraken test... 09:33:06 INFO - TEST-INFO | started process 24690 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLxZ8ue/profile http://localhost:47452/getInfo.html) 09:33:10 INFO - PROCESS | 24690 | __metrics Screen width/height:1600/1200 09:33:10 INFO - PROCESS | 24690 | colorDepth:24 09:33:10 INFO - PROCESS | 24690 | Browser inner width/height: 1024/697 09:33:10 INFO - PROCESS | 24690 | __metrics 09:33:11 INFO - PROCESS | 24690 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 09:33:11 INFO - PROCESS | 24690 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 09:33:12 INFO - PROCESS | 24690 | console.error: PushService: 09:33:12 INFO - PROCESS | 24690 | stateChangeProcessEnqueue: Error transitioning state 09:33:12 INFO - PROCESS | 24690 | UnknownError 09:33:12 INFO - TEST-INFO | 24690: exit 0 09:33:12 INFO - Browser initialized. 09:33:12 INFO - Running cycle 1/1 for kraken test... 09:33:12 INFO - TEST-INFO | started process 24785 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpLxZ8ue/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:33:24 INFO - PROCESS | 24785 | RSS: Main: 138014720 09:33:24 INFO - PROCESS | 24785 | 09:33:27 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47452/tests/kraken/driver.html?testName=audio-beat-detection) 09:33:27 INFO - PROCESS | 24785 | RSS: Main: 181456896 09:33:27 INFO - PROCESS | 24785 | 09:33:30 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47452/tests/kraken/driver.html?testName=audio-dft) 09:33:31 INFO - PROCESS | 24785 | RSS: Main: 172326912 09:33:31 INFO - PROCESS | 24785 | 09:33:33 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47452/tests/kraken/driver.html?testName=audio-fft) 09:33:34 INFO - PROCESS | 24785 | RSS: Main: 263815168 09:33:34 INFO - PROCESS | 24785 | 09:33:36 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47452/tests/kraken/driver.html?testName=audio-oscillator) 09:33:37 INFO - PROCESS | 24785 | RSS: Main: 170151936 09:33:37 INFO - PROCESS | 24785 | 09:33:39 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47452/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:33:39 INFO - PROCESS | 24785 | RSS: Main: 172539904 09:33:39 INFO - PROCESS | 24785 | 09:33:42 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47452/tests/kraken/driver.html?testName=imaging-darkroom) 09:33:43 INFO - PROCESS | 24785 | RSS: Main: 211369984 09:33:43 INFO - PROCESS | 24785 | 09:33:46 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47452/tests/kraken/driver.html?testName=imaging-desaturate) 09:33:47 INFO - PROCESS | 24785 | RSS: Main: 209408000 09:33:47 INFO - PROCESS | 24785 | 09:33:49 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47452/tests/kraken/driver.html?testName=json-parse-financial) 09:33:50 INFO - PROCESS | 24785 | RSS: Main: 207425536 09:33:50 INFO - PROCESS | 24785 | 09:33:52 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47452/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:33:52 INFO - PROCESS | 24785 | RSS: Main: 170184704 09:33:52 INFO - PROCESS | 24785 | 09:33:54 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:33:55 INFO - PROCESS | 24785 | RSS: Main: 177532928 09:33:55 INFO - PROCESS | 24785 | 09:33:57 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:33:57 INFO - PROCESS | 24785 | RSS: Main: 181653504 09:33:57 INFO - PROCESS | 24785 | 09:34:00 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:34:00 INFO - PROCESS | 24785 | RSS: Main: 178032640 09:34:00 INFO - PROCESS | 24785 | 09:34:03 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:34:04 INFO - PROCESS | 24785 | RSS: Main: 181420032 09:34:04 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | Cycle 1(1): loaded http://localhost:47452/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47452/tests/kraken/driver.html?testName=ai-astar) 09:34:05 INFO - PROCESS | 24785 | RSS: Main: 235069440 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | __start_tp_report 09:34:05 INFO - PROCESS | 24785 | _x_x_mozilla_page_load 09:34:05 INFO - PROCESS | 24785 | _x_x_mozilla_page_load_details 09:34:05 INFO - PROCESS | 24785 | |i|pagename|runs| 09:34:05 INFO - PROCESS | 24785 | |0;ai-astar;110;111;110;109;112;111;112;111;109;110 09:34:05 INFO - PROCESS | 24785 | |1;audio-beat-detection;148;126;117;154;119;119;116;121;140;122 09:34:05 INFO - PROCESS | 24785 | |2;audio-dft;162;161;165;160;161;161;162;162;159;160 09:34:05 INFO - PROCESS | 24785 | |3;audio-fft;75;75;75;106;75;76;76;76;90;76 09:34:05 INFO - PROCESS | 24785 | |4;audio-oscillator;81;82;105;81;82;82;92;81;82;99 09:34:05 INFO - PROCESS | 24785 | |5;imaging-gaussian-blur;117;117;117;117;118;117;117;117;118;117 09:34:05 INFO - PROCESS | 24785 | |6;imaging-darkroom;146;147;145;146;146;147;146;147;146;146 09:34:05 INFO - PROCESS | 24785 | |7;imaging-desaturate;97;96;96;96;97;95;96;95;96;95 09:34:05 INFO - PROCESS | 24785 | |8;json-parse-financial;51;51;52;51;50;50;51;54;51;51 09:34:05 INFO - PROCESS | 24785 | |9;json-stringify-tinderbox;63;65;65;63;64;63;64;64;64;64 09:34:05 INFO - PROCESS | 24785 | |10;stanford-crypto-aes;78;78;76;77;78;78;75;75;78;94 09:34:05 INFO - PROCESS | 24785 | |11;stanford-crypto-ccm;128;118;129;118;117;124;119;123;125;125 09:34:05 INFO - PROCESS | 24785 | |12;stanford-crypto-pbkdf2;161;154;155;158;155;154;155;153;154;153 09:34:05 INFO - PROCESS | 24785 | |13;stanford-crypto-sha256-iterative;61;60;61;60;58;61;66;61;58;60 09:34:05 INFO - PROCESS | 24785 | __end_tp_report 09:34:05 INFO - PROCESS | 24785 | __start_cc_report 09:34:05 INFO - PROCESS | 24785 | _x_x_mozilla_cycle_collect,1522 09:34:05 INFO - PROCESS | 24785 | __end_cc_report 09:34:05 INFO - PROCESS | 24785 | __startTimestamp1488735245982__endTimestamp 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | ------- Summary: start ------- 09:34:05 INFO - PROCESS | 24785 | Number of tests: 14 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#0] ai-astar Cycles:10 Average:110.50 Median:111.00 stddev:1.08 (1.0%) stddev-sans-first:1.13 09:34:05 INFO - PROCESS | 24785 | Values: 110.0 111.0 110.0 109.0 112.0 111.0 112.0 111.0 109.0 110.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#1] audio-beat-detection Cycles:10 Average:128.20 Median:124.00 stddev:13.89 (11.2%) stddev-sans-first:12.75 09:34:05 INFO - PROCESS | 24785 | Values: 148.0 126.0 117.0 154.0 119.0 119.0 116.0 121.0 140.0 122.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:1.64 (1.0%) stddev-sans-first:1.72 09:34:05 INFO - PROCESS | 24785 | Values: 162.0 161.0 165.0 160.0 161.0 161.0 162.0 162.0 159.0 160.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#3] audio-fft Cycles:10 Average:80.00 Median:76.00 stddev:10.22 (13.4%) stddev-sans-first:10.68 09:34:05 INFO - PROCESS | 24785 | Values: 75.0 75.0 75.0 106.0 75.0 76.0 76.0 76.0 90.0 76.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#4] audio-oscillator Cycles:10 Average:86.70 Median:82.00 stddev:8.82 (10.8%) stddev-sans-first:9.11 09:34:05 INFO - PROCESS | 24785 | Values: 81.0 82.0 105.0 81.0 82.0 82.0 92.0 81.0 82.0 99.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 09:34:05 INFO - PROCESS | 24785 | Values: 117.0 117.0 117.0 117.0 118.0 117.0 117.0 117.0 118.0 117.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 09:34:05 INFO - PROCESS | 24785 | Values: 146.0 147.0 145.0 146.0 146.0 147.0 146.0 147.0 146.0 146.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.74 (0.8%) stddev-sans-first:0.67 09:34:05 INFO - PROCESS | 24785 | Values: 97.0 96.0 96.0 96.0 97.0 95.0 96.0 95.0 96.0 95.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#8] json-parse-financial Cycles:10 Average:51.20 Median:51.00 stddev:1.14 (2.2%) stddev-sans-first:1.20 09:34:05 INFO - PROCESS | 24785 | Values: 51.0 51.0 52.0 51.0 50.0 50.0 51.0 54.0 51.0 51.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#9] json-stringify-tinderbox Cycles:10 Average:63.90 Median:64.00 stddev:0.74 (1.2%) stddev-sans-first:0.71 09:34:05 INFO - PROCESS | 24785 | Values: 63.0 65.0 65.0 63.0 64.0 63.0 64.0 64.0 64.0 64.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#10] stanford-crypto-aes Cycles:10 Average:78.70 Median:78.00 stddev:5.52 (7.1%) stddev-sans-first:5.85 09:34:05 INFO - PROCESS | 24785 | Values: 78.0 78.0 76.0 77.0 78.0 78.0 75.0 75.0 78.0 94.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#11] stanford-crypto-ccm Cycles:10 Average:122.60 Median:124.50 stddev:4.35 (3.5%) stddev-sans-first:4.15 09:34:05 INFO - PROCESS | 24785 | Values: 128.0 118.0 129.0 118.0 117.0 124.0 119.0 123.0 125.0 125.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:155.20 Median:155.00 stddev:2.49 (1.6%) stddev-sans-first:1.51 09:34:05 INFO - PROCESS | 24785 | Values: 161.0 154.0 155.0 158.0 155.0 154.0 155.0 153.0 154.0 153.0 09:34:05 INFO - PROCESS | 24785 | 09:34:05 INFO - PROCESS | 24785 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.60 Median:61.00 stddev:2.22 (3.6%) stddev-sans-first:2.35 09:34:05 INFO - PROCESS | 24785 | Values: 61.0 60.0 61.0 60.0 58.0 61.0 66.0 61.0 58.0 60.0 09:34:05 INFO - PROCESS | 24785 | -------- Summary: end -------- 09:34:05 INFO - PROCESS | 24785 | 09:34:07 INFO - TEST-INFO | 24785: exit 0 09:34:07 INFO - TEST-OK | kraken | took 60512ms 09:34:07 INFO - SUITE-END | took 1174s 09:34:07 INFO - Completed test suite (00:19:34) 09:34:07 INFO - javascript benchmark 09:34:07 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3268.5750852389187, 3277.770556061076, 3305.7024867761897, 3333.783304085233, 3345.983270083649, 5346.091164502034, 5403.243545903567, 5405.756740946657, 5416.783328666848, 5433.673979561219, 5378.1663842104535, 5413.106837371839, 5428.158635411518, 5430.83707488775, 5436.836894893149, 4917.21324588066, 4938.678985865925, 4998.325226094467, 5012.072766538184, 5024.145895197807, 4885.487023862496, 5006.299118123466, 5064.341635587369, 5067.163917953533, 5094.184930411135, 4870.025994801036, 4932.309476673268, 4952.653314268003, 4956.975215123919, 5035.571976381993, 4993.0, 5031.32077169581, 5033.597312215014, 5037.748112594392, 5067.61992850534, 4966.404031516205, 4983.377077865267, 5004.074246264417, 5012.649114561982, 5024.824131155428, 5231.0, 5353.357597088336, 5405.054115529767, 5473.863153421156, 5478.671279723229, 5821.912671309891, 5828.1549175369755, 5835.183074369592, 5846.619969701956, 5872.970635146797, 5834.0373838317055, 5873.412658734135, 5882.735276912549, 5894.440028197358, 5918.792842250544, 5310.150375939869, 5390.353157621072, 5402.621816472888, 5430.321209848769, 5505.642133261325, 5880.647161170344, 5898.1152827076285, 5909.349971503131, 5932.584719069624, 5949.25634295713, 5704.22992895962, 5706.343770466449, 5710.65736055838, 5713.114467257582, 5726.742296596663, 5618.4662457066515, 5671.319441667027, 5725.828225153252, 5746.540276777848, 5796.88406231873, 5739.942600573941, 5749.367569567345, 5808.983427900101, 5839.941600584025, 5843.1235314703135, 5803.245578074823, 5806.419358064244, 5808.883822323614, 5811.564132690065, 5828.242328497268, 4396.868093957187, 4436.179306828247, 4488.438945131858, 4501.144782491317, 4506.864794056183, 3993.940090898639, 4034.4755181826176, 4038.676905847525, 4042.555318914917, 4078.5921407858978, 5592.804251851166, 5604.523615492729, 5609.887802243932, 5612.158176273591, 5635.605507614428, 5636.605437619327, 5670.659760414306, 5801.3038435388025, 5867.911981320283, 5897.351291357947, 5596.356419011784, 5639.125935480007, 5657.094864821609, 5660.0, 5691.03252447085, 5037.82367617139, 5042.949570504248, 5048.217526283432, 5058.620603454682, 5071.5689166420525, 5895.9999999999145, 5903.645781253139, 6091.695415229221, 6132.816015519542, 6155.076738489262, 5783.19035335045, 5818.970905145447, 5819.330776960704, 5874.383189765013, 5899.705014749331, 6057.273127224761, 6064.696765161812, 6065.5754097212775, 6065.757369705162, 6072.423119803611, 5565.6104072714525, 5716.228309178207, 5755.1367294906095, 5774.624649397776, 5779.595428319977, 5702.942970570241, 5714.571407144564, 5786.103154011135, 5795.94204057954, 5874.353821079592, 5616.943830561642, 5676.602637815313, 5677.971610141923, 5680.091185410314, 5692.1461780733225, 5655.660660360391, 5662.235598194191, 5691.658500489818, 5695.202671625892, 5695.971520142372, 5480.725963701879, 5497.147942068986, 5519.3652729936575, 5526.22632831412, 5529.778808847601, 5609.1305847593685, 5610.5231055360755, 5623.718814059363, 5625.043742563692, 5650.463205995424, 5503.917441238465, 5506.339239291311, 5507.146392309199, 5511.366192887869, 5512.972435137799], "value": 5375.203544193849, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [550.1343236409608, 590.1236663554622, 618.8983609175667, 619.3187493756865, 648.5233353485185, 36562.0, 47709.04581908364, 48469.757651211694, 48575.0, 48590.999999999956, 50480.49519504804, 50995.745021274844, 51030.74484627581, 51101.48898511014, 51183.744081279634, 8825.691100811473, 9403.294752893544, 9572.0, 9583.424994500318, 9588.95205523975, 8754.474731516098, 10939.945300273488, 11144.052755515791, 11152.275102118378, 11601.477933492972, 11281.097512199045, 11347.148963827705, 11359.318440893532, 11361.602343917964, 11363.886361136365, 11360.204785665006, 11405.885941140565, 11408.315501069963, 11415.771684566304, 11430.37132957687, 11373.772524549546, 11398.487068081957, 11403.828942565786, 11450.42747862612, 11451.312921224753, 48670.75664621654, 48856.26715599269, 49071.0, 49104.75447622775, 49171.2624310632, 4344.218040752663, 4485.237509623372, 4494.438195225597, 4500.302453119772, 4668.043051174535, 32039.359212815612, 32214.355712885612, 32219.19452013695, 32591.348173036407, 33355.0, 4430.534793846664, 4430.689851710382, 4437.64498840092, 4463.330500424962, 4488.035072459405, 361095.0, 362939.0, 362999.0, 364308.9999999973, 364698.0, 61932.38067619356, 61933.07100393498, 62139.0, 62267.0, 62418.687906561085, 65441.672791635734, 65477.0, 65556.0, 65568.0, 65683.0, 17963.371282005068, 18418.907905460386, 18421.355252566096, 18425.26298948054, 18446.631067378577, 13548.59354219375, 13757.0, 13893.096948698303, 13903.582892513241, 14274.286285685881, 18765.155567999474, 19158.904205478884, 19268.0, 19426.611467770566, 19478.0, 7377.483576149725, 7405.407567394595, 7494.962525187449, 7539.849203015909, 7621.618919054025, 938.4603852784676, 960.7213907966611, 966.5553845231273, 969.9612015519441, 970.0154343341515, 31076.0, 32142.35715285728, 32742.50886236708, 32856.0, 33694.98915032553, 992.9304948653669, 1135.4266095621824, 1148.615213903335, 1163.4589915689075, 1177.7821103095955, 16650.16749162537, 17709.0, 17795.644087118184, 17851.28594856217, 17948.37180698669, 150675.24662376838, 151822.0, 152143.0, 152195.0, 152883.23558382137, 67859.0, 68210.65894670594, 68428.6578567104, 68573.0, 68665.65667171632, 1503.4888138032902, 1523.474401331539, 1538.8999715018713, 1544.2819089123611, 1576.1961399686243, 29602.0, 31336.809883239664, 31435.685643143275, 31586.210344741565, 31961.6803831968, 55844.72077639586, 56315.71842140763, 56317.71841140768, 56407.43592564022, 56570.717146414005, 330988.0, 331082.0, 332067.0, 332421.0, 332832.0, 28400.85799570989, 28931.855340723163, 29949.0, 30633.693663063084, 31600.841995789873, 45377.546224537335, 52589.474105259986, 52980.470195299094, 53038.0, 53076.0, 43117.0, 43557.0, 44123.33814992842, 44784.0, 46180.769096154305, 42986.14027719491, 44365.1804670913, 44466.3330050043, 45493.31760023668, 46081.0, 43101.78449107734, 43644.127117458105, 44249.33625995677, 44816.0, 45208.32187517256, 35736.642633573334, 39019.6098039016, 39170.80414597909, 39355.38253587493, 39513.60486395099, 28676.569851452663, 28777.071845280672, 28966.7103328964, 29203.269918252212, 29231.0], "value": 20865.149601972338, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [419.68942982193147, 428.0813453420201, 435.7320248047451, 440.37466797148045, 440.76419115773047, 20419.99999999998, 21191.152353905843, 21428.357149285548, 21537.353879383645, 21756.347309580717, 22233.333000009985, 22936.65595016072, 23089.653655195143, 23203.883980580114, 23583.0, 5965.46310832025, 6116.81649550512, 6175.104609831572, 6176.0, 6183.752649893999, 6054.96972515139, 6267.843303917393, 6307.022411526221, 6352.587081839689, 6365.0, 6366.108744775735, 6372.139761132257, 6383.042543618448, 6517.837054073662, 6944.652767361637, 7055.541389809671, 7060.894086588705, 7076.646167691595, 7091.113610798624, 7093.219745827955, 6121.234845644294, 6261.749530018794, 6266.968665156645, 6298.590591611531, 6309.810705678837, 14771.482998095014, 14790.70418591633, 14839.629009274855, 14894.925525372411, 14995.250237488082, 2814.8170368926158, 3112.1908303840937, 3124.297033167519, 3130.311331507065, 3177.507486339598, 10370.533326000348, 10455.68632941013, 10590.0, 10679.786404271948, 11128.944355278252, 1998.1707591349573, 2022.7269318641943, 2119.8728076315315, 2125.6280150973516, 2128.053016407699, 86232.0, 95776.0, 97442.51278743632, 99681.0, 100714.49642751813, 11167.0, 11229.10167186623, 11297.887021129847, 11389.829152562717, 11603.0, 16162.35350585987, 16184.676306473804, 16193.190340483165, 16201.0, 16221.67556648884, 8474.322054235647, 8951.955240223757, 8981.865272020925, 9164.312676549152, 9175.403598766059, 8803.207711305886, 8870.201681848535, 8886.777830554158, 9072.81854362909, 9119.0, 4725.64557658177, 4728.95271047292, 4777.092352453023, 4828.806847726122, 4847.151748444008, 2054.3220737156703, 2077.6987336836073, 2102.821260192901, 2169.631162702313, 2172.3048624440344, 868.5874209750318, 881.5239770523973, 893.6738090596886, 903.7514683461969, 910.4491782471641, 20303.695444568344, 21114.261000864895, 21170.082343539718, 21192.36422907315, 21247.36257912265, 910.0580898769741, 913.0960349254191, 920.0845159066771, 930.7533503621411, 939.2626787971546, 11475.426228688531, 11546.134039947037, 11642.126840486997, 11717.765644687059, 11787.35169565665, 725403.0, 738104.0, 757421.0, 757681.0, 763180.0, 83634.29119923094, 90196.5490172545, 98984.5050774756, 109700.0, 114263.42868285606, 1103.2663278919429, 1150.3500522204927, 1163.1215586827213, 1172.724409763722, 1175.1538891997748, 19264.422067338, 19641.0, 19740.30908918181, 19917.30289439863, 19972.20111195536, 49099.754501228694, 49164.0, 49559.256611151584, 49984.500154997986, 50950.74524627353, 71785.28214717995, 71815.0, 72220.0, 72578.63710681624, 73301.0, 8285.25432711059, 8518.190771876662, 8708.738737837875, 8870.556472176237, 9430.245580353418, 10347.43089130105, 13716.245606491739, 14647.853521464649, 14980.925095374454, 15122.017068890487, 9728.562214700498, 10004.399736015863, 12240.326782027074, 12286.877131228573, 12423.937880310541, 8304.418690691835, 12560.057995650546, 12719.236845789283, 12790.232586044867, 12923.289219092663, 8169.754907352789, 10688.786224275316, 12162.209456385306, 12604.495820167458, 12737.617871463872, 8342.582870856311, 8518.957405212934, 8607.440516366416, 8670.869936950825, 8734.82530349402, 12320.260784352968, 12773.297468639314, 12952.676183095122, 12965.15726477776, 12986.285754283605], "value": 9949.50244797201, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1455.3232746772749, 1490.6646004648956, 1511.3954418232706, 1519.4757808556049, 1540.2760702469843, 8008.919910800891, 8479.406441549094, 8479.830403391928, 8500.0, 8502.829943401128, 7238.384737297336, 7416.110066791979, 7955.92044079559, 8186.181381861811, 8349.123342049088, 2212.7344718633785, 2251.34710933829, 2252.831037672173, 2254.211026140854, 2262.7850354216407, 2205.514786746913, 2228.0, 2245.461089338555, 2246.550689862026, 2247.045005872506, 2125.2455378340696, 2127.755308139568, 2150.602138604363, 2151.1610471915965, 2180.0843645668856, 2152.547964927367, 2164.9242276520326, 2172.283146561647, 2175.749788774295, 2177.923772667957, 2127.2022991378235, 2167.8590891592153, 2170.4248374180856, 2172.9565408691897, 2175.673648952654, 8347.457415268049, 8411.411201215917, 8422.368322375847, 8429.735539669038, 8433.831323373559, 5106.821261255838, 5197.8440646780655, 5212.478752124757, 5214.478552144755, 5234.659747116425, 3153.9743212780463, 3271.2312606537444, 3287.211069343364, 3305.2563173286057, 3305.93388132236, 1190.7618476304688, 1283.5507572349695, 1316.776148054833, 1329.9401526931215, 1407.0713329202779, 11481.770364592745, 11516.654500365003, 11521.654350369503, 11528.308301501853, 11548.24936379141, 4210.789460526961, 4501.977490112594, 4575.405197324393, 4657.183698357643, 4672.883177920511, 9861.112499875046, 9871.703848884545, 9872.111509964137, 9873.50632468388, 9882.308238423242, 5131.948680513222, 5148.9485105149215, 5151.562117220078, 5152.27868098459, 5152.381714194245, 4033.5361433434946, 4135.359019352005, 4645.117427688729, 4734.810607575659, 4818.084563932912, 3928.744631598937, 3964.048628329238, 4007.519097708294, 4033.91932161361, 4039.434479172918, 1249.2192379762648, 1263.8293830332786, 1264.4246867675186, 1265.6329664397406, 1268.4165283969478, 924.6948506992676, 930.1582068228264, 935.4527601353149, 943.6319835264252, 943.9056094390643, 5262.657927234717, 5848.327442344185, 5849.970750146307, 5911.556633252523, 6113.174721412642, 997.5261750668375, 1021.6973358967376, 1027.9794404111876, 1044.5821671331528, 1049.6536143072767, 3453.3438646657055, 3508.438649816017, 3607.0, 3632.3461776880417, 3641.5266015418356, 9831.066048725359, 9978.750531236778, 10061.69814905554, 10071.496425178711, 10239.795204095877, 9912.405255684538, 9978.401295922124, 10012.799744005224, 10014.29899907014, 10024.097831195228, 7538.547687138789, 7717.807054823562, 7724.884126738103, 7731.690732370755, 7805.531668099932, 5061.0933438440225, 5107.155974230931, 5148.014151791876, 5201.843944681666, 5207.505286997729, 9026.503542304974, 9050.502222377832, 9054.81890362176, 9062.546872656472, 9148.359614826899, 8920.375573709778, 9088.727338179866, 9140.314476414163, 9143.63425462974, 9201.907980920105, 6272.74909003653, 6306.148669929685, 6830.624315662686, 6970.093887794555, 7087.14954205478, 8299.336053115616, 8366.03790564093, 8367.707130250412, 8372.665093396196, 8384.580770961305, 7291.234420385783, 7355.0, 7396.3343299103335, 7397.852042959218, 7463.888041679271, 7054.0, 7061.6469176542, 7079.362857342864, 7091.361777440055, 7127.465440092117, 6453.677316134268, 6549.901751473636, 6557.606543607399, 6557.868842623217, 6561.835954101186, 4803.303520989367, 4943.77753001123, 4987.226979818134, 5006.349174607278, 5064.366954130734, 5021.648484606042, 5027.0, 5165.483451654804, 5170.844874653616, 5209.166533354645], "value": 4423.1907322159295, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [383.82344121704034, 401.8493065100588, 402.41247778243763, 404.04241946586575, 405.85389259866463, 5398.757055932482, 5410.4319046500095, 5414.269073675053, 5425.593080518957, 5431.83704488865, 5094.694318340902, 5177.922331165026, 5258.789648414059, 5301.575873930086, 5329.280547126137, 4266.501468795589, 4285.378620100076, 4305.354196870463, 4339.414179085815, 4349.238883195444, 4268.231718290706, 4290.4636920384955, 4298.505671847746, 4308.719933204332, 4317.503487098977, 4069.0, 4106.733062350952, 4215.304474761676, 4286.057067445157, 4322.82708691652, 4268.65537355732, 4269.946987903632, 4270.38079478477, 4274.722143060707, 4281.850135245282, 3872.6514613684903, 3879.3792993121247, 3882.825272862728, 3888.494495715539, 3889.747166434173, 5060.67105638136, 5175.585953123741, 5193.0, 5261.842144735664, 5268.631195816256, 4872.951270487285, 4890.73100979446, 4908.7300198489065, 4919.532644398776, 4923.359963204761, 5566.35986861508, 5602.859928501779, 5610.579206559524, 5612.803551875665, 5624.5781566382275, 3910.648041676263, 4022.6781857451333, 4053.7973101344814, 4273.508546517128, 4296.978515107436, 5706.743196556124, 5721.199032135504, 5732.627379220337, 5743.770249190027, 5757.107648314518, 4127.504699436087, 4133.379993001014, 4142.565030671736, 4142.91714165715, 4164.125533637909, 3979.6816254699556, 4096.32410652239, 4221.641160501392, 4222.451081359465, 4224.281872081753, 4699.765011749399, 4750.714957102516, 4757.35775670287, 4758.738934182445, 4772.969164580447, 5588.860278492989, 5608.383077861432, 5623.184638227434, 5625.240592520039, 5658.207850900877, 1348.6493511686836, 1401.53048728675, 1416.667083235439, 1422.38837299962, 1423.8576142385677, 961.2262128986233, 971.7424882406168, 973.5035132082688, 978.2223132609593, 978.8238117138983, 5232.3459567554055, 5233.555147812479, 5249.448807875118, 5275.709835958983, 5317.361916570037, 5554.750036248379, 5558.694271815089, 5570.526505247019, 5572.637778544382, 5584.301962254718, 5172.560332371715, 5296.655717378435, 5326.36083669962, 5338.332708411449, 5404.567634589223, 2933.559966005116, 2955.2168675301064, 2965.1845742420574, 2970.2425881400104, 2974.8512574371193, 5823.515003674036, 5827.202942587497, 5842.532597392198, 5846.298444186725, 5854.4730974212525, 5516.0, 5598.21624972496, 5612.691301978431, 5664.773409063591, 5681.659100453986, 5729.914051289234, 5785.0, 5785.71071446426, 5831.70841457917, 5831.912521312099, 5341.931613677202, 5527.0, 5571.9721401392735, 5590.0, 5635.436456354331, 5511.448855114617, 5517.420670829505, 5531.557475401878, 5581.972090139523, 5600.635958662674, 5705.572082093777, 5748.626339287933, 5748.885022299614, 5868.94131058684, 5895.793647222326, 4050.9797451012555, 4231.809568569361, 4249.617534421917, 4253.91492170161, 4323.243432399255, 5475.508643567087, 5642.492175704207, 5656.60403771732, 5759.280089988752, 5771.220885180447, 5564.805231816867, 5569.220309156641, 5578.3584887738425, 5620.18507316445, 5620.494155525858, 5311.707856067799, 5552.750126244409, 5582.665040097607, 5597.888042239214, 5601.383847776659, 5574.9721251393485, 5580.441955804387, 5594.468525490072, 5597.468240517144, 5600.691961942132, 5644.4035743558425, 5645.294338207724, 5655.519280861008, 5655.915161272502, 5673.234113394639, 5260.237265596391, 5499.670019798825, 5544.564348521248, 5546.833594992157, 5549.528290095225], "value": 4295.2313503682535, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [742.5507567921404, 757.9621018949051, 778.8130848596335, 821.3757544266358, 821.7781199076247, 16011.839881601196, 17228.741568876478, 17283.0, 17334.219960101793, 17366.218520166592, 15386.153761543139, 15615.531534053996, 15646.530604081867, 15648.217589120555, 15658.060516369025, 680.6120511308557, 697.7941507255372, 808.5593351623379, 816.1715858403725, 824.8350329934008, 834.8580741273998, 836.017679226909, 837.2088376484224, 837.4598384042289, 837.7570504553703, 880.4409200157913, 886.264400547544, 887.4409122252972, 887.6937456577471, 888.0542222533014, 741.6921977379382, 751.6842925971105, 851.9148085191493, 868.8827008353854, 881.8633111867671, 641.3586413586413, 642.3640595810115, 642.4507046475243, 642.752540271994, 643.0450780590819, 15304.311305991147, 15388.076715397001, 15402.0, 15438.5368438947, 15684.76472852908, 14437.350319235555, 14973.326200321011, 15314.463993760277, 15495.767563486557, 15515.0, 14071.71856562863, 14096.224707641075, 14144.646383840487, 14342.64143396413, 14366.425342986267, 3928.3125453045886, 3948.7630742155275, 3979.204159168149, 4078.3882417637296, 4575.725456472623, 83444.58277708634, 84173.57913210455, 84532.0, 86353.99999999937, 87020.56489717575, 11676.182667213214, 11728.179027467995, 11741.447139086666, 11843.940780296043, 11961.641150765317, 22290.554188916132, 22379.0, 22663.093476261096, 22674.639521628425, 22714.43213919632, 8218.958905205436, 8283.37874659391, 8428.115047920002, 8510.532739305916, 8663.566821658891, 4353.390525326457, 4509.661775366861, 4667.159911216014, 4866.172750632401, 4890.731009794425, 3641.2717456508276, 3769.359208934488, 3772.5284339457567, 3773.52830896138, 3774.6602805747616, 617.4381313005233, 619.6746707978257, 632.6678493790797, 644.2365796531126, 644.4940721533574, 665.6638397609273, 704.7779949315949, 707.8088915992653, 750.8385697075155, 832.6128350317132, 10094.899051009543, 11060.17048721333, 11398.658040258806, 11422.828657570142, 11699.181057326075, 614.0, 618.42486487567, 619.278540500312, 622.3620788691537, 651.4299987510927, 5237.376413311886, 5302.522772950453, 5350.5184533392185, 5352.0, 5379.811706590329, 69517.65241173863, 78058.0, 79395.20604793879, 79581.60209198917, 80284.59857700791, 71500.64249678719, 72215.0, 72225.6388718053, 72880.63559682168, 73757.26242737504, 65313.67343163254, 65542.0, 66187.33812661908, 66584.33415665878, 67601.0, 9521.904780952378, 9821.75661585803, 9846.31075824714, 9879.20966322678, 9887.604495820087, 43325.58278185158, 43516.78241608771, 43667.56332436635, 44182.77908610436, 44888.32667510055, 53950.73024635009, 54958.45041549533, 55671.72164139153, 55956.0, 56844.71577642085, 12459.314737689514, 12793.61619151427, 12909.559698532403, 12975.935120324339, 13049.37791213958, 12891.226526408445, 13017.739645206853, 13095.67260818449, 13281.269530175932, 13353.732925341244, 11618.76762464763, 12179.634610961686, 13442.865571344162, 13656.726865462437, 13735.313234338044, 13311.267880266678, 13668.863311367157, 13828.585142445743, 13937.790933135808, 14362.856371436152, 13408.731825363244, 13503.662408439475, 13508.189508629514, 13612.0, 13875.306234688427, 11178.217524773188, 11423.485943132413, 11524.94237528807, 11525.827112593486, 11801.0, 11017.61438349686, 11726.355050472306, 12489.250644961332, 12776.169548979658, 13106.672333191365], "value": 7449.054928830418, "unit": "score"}], "name": "dromaeo_css", "value": 7352.1597477422865, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [110.0, 111.0, 110.0, 109.0, 112.0, 111.0, 112.0, 111.0, 109.0, 110.0], "value": 110.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 126.0, 117.0, 154.0, 119.0, 119.0, 116.0, 121.0, 140.0, 122.0], "value": 128.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 161.0, 165.0, 160.0, 161.0, 161.0, 162.0, 162.0, 159.0, 160.0], "value": 161.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 106.0, 75.0, 76.0, 76.0, 76.0, 90.0, 76.0], "value": 80.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 82.0, 105.0, 81.0, 82.0, 82.0, 92.0, 81.0, 82.0, 99.0], "value": 86.7, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 117.0, 117.0, 118.0, 117.0, 117.0, 117.0, 118.0, 117.0], "value": 117.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 145.0, 146.0, 146.0, 147.0, 146.0, 147.0, 146.0, 146.0], "value": 146.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [97.0, 96.0, 96.0, 96.0, 97.0, 95.0, 96.0, 95.0, 96.0, 95.0], "value": 95.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 51.0, 52.0, 51.0, 50.0, 50.0, 51.0, 54.0, 51.0, 51.0], "value": 51.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 65.0, 65.0, 63.0, 64.0, 63.0, 64.0, 64.0, 64.0, 64.0], "value": 63.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 78.0, 76.0, 77.0, 78.0, 78.0, 75.0, 75.0, 78.0, 94.0], "value": 78.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [128.0, 118.0, 129.0, 118.0, 117.0, 124.0, 119.0, 123.0, 125.0, 125.0], "value": 122.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 154.0, 155.0, 158.0, 155.0, 154.0, 155.0, 153.0, 154.0, 153.0], "value": 155.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [61.0, 60.0, 61.0, 60.0, 58.0, 61.0, 66.0, 61.0, 58.0, 60.0], "value": 60.6, "unit": "score"}], "name": "kraken", "value": 1458.2, "alertThreshold": 2.0}]} 09:34:07 INFO - Return code: 0 09:34:07 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:34:07 ERROR - # TBPL SUCCESS # 09:34:07 INFO - Running post-action listener: _resource_record_post_action 09:34:07 INFO - [mozharness: 2017-03-05 17:34:07.265904Z] Finished run-tests step (success) 09:34:07 INFO - Running post-run listener: _resource_record_post_run 09:34:07 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 262144; Write bytes: 379142144; Read time: 16; Write time: 254520 09:34:07 INFO - TinderboxPrint: CPU usage
13.0% 09:34:07 INFO - TinderboxPrint: I/O read bytes / time
262,144 / 16 09:34:07 INFO - TinderboxPrint: I/O write bytes / time
379,142,144 / 254,520 09:34:07 INFO - TinderboxPrint: CPU idle
8,266.9 (87.0%) 09:34:07 INFO - TinderboxPrint: CPU user
1,192.7 (12.5%) 09:34:07 INFO - TinderboxPrint: Swap in / out
0 / 0 09:34:07 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 109645824; Read time: 0; Write time: 103292 09:34:07 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 262144; Write bytes: 251969536; Read time: 16; Write time: 148644 09:34:07 INFO - Running post-run listener: _upload_blobber_files 09:34:07 INFO - Blob upload gear active. 09:34:07 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:34:07 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 09:34:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 09:34:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 09:34:08 INFO - (blobuploader) - INFO - Open directory for files ... 09:34:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 09:34:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:34:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:34:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 09:34:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:34:09 INFO - (blobuploader) - INFO - Done attempting. 09:34:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 09:34:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:34:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:34:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 09:34:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:34:09 INFO - (blobuploader) - INFO - Done attempting. 09:34:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 09:34:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:34:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:34:10 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 09:34:10 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:34:10 INFO - (blobuploader) - INFO - Done attempting. 09:34:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:34:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:34:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:34:14 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:34:14 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:34:14 INFO - (blobuploader) - INFO - Done attempting. 09:34:14 INFO - (blobuploader) - INFO - Iteration through files over. 09:34:14 INFO - Return code: 0 09:34:14 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:34:14 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:34:14 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/29a73d8d322b8f6d219758a0dd8e0d22eb2cb496237f6c17a364b379323e6fc0a92c24dc2d16638d8185a2a629cbd7841b59b30922c15e32ab065324c7d92c3e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/f93838daf9d0fdeb13ffe58ccb30b6a8beebfe2be7863e004477eaa7fb4e9bc9787538f55c32c24b0f55672aad396c08cd027ca2b5ae0778d07fbfdb085e270e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/c97cd3183cddceb7e113b36c343cb843e2ed9a7cab5af818b3d622085000871f14a582ecf2c673565718b4273ceb6b99492ea137932f5f84d811136540777196", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/90b087513b51dedebe61f9c6ad3091ff05d5d2965554f0389312680a39cea027559be319aa889907b96551c854f468416c98240cb7349b4dc403da14306c0128"} 09:34:14 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:34:14 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:34:14 INFO - Contents: 09:34:14 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/29a73d8d322b8f6d219758a0dd8e0d22eb2cb496237f6c17a364b379323e6fc0a92c24dc2d16638d8185a2a629cbd7841b59b30922c15e32ab065324c7d92c3e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/f93838daf9d0fdeb13ffe58ccb30b6a8beebfe2be7863e004477eaa7fb4e9bc9787538f55c32c24b0f55672aad396c08cd027ca2b5ae0778d07fbfdb085e270e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/c97cd3183cddceb7e113b36c343cb843e2ed9a7cab5af818b3d622085000871f14a582ecf2c673565718b4273ceb6b99492ea137932f5f84d811136540777196", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/90b087513b51dedebe61f9c6ad3091ff05d5d2965554f0389312680a39cea027559be319aa889907b96551c854f468416c98240cb7349b4dc403da14306c0128"} 09:34:14 INFO - Running post-run listener: copy_logs_to_upload_dir 09:34:14 INFO - Copying logs to upload dir... 09:34:14 INFO - mkdir: /builds/slave/test/build/upload/logs 09:34:14 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1236.685953 ========= master_lag: -0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 36 secs) (at 2017-03-05 09:34:13.443921) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-05 09:34:13.448020) ========= 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=781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/29a73d8d322b8f6d219758a0dd8e0d22eb2cb496237f6c17a364b379323e6fc0a92c24dc2d16638d8185a2a629cbd7841b59b30922c15e32ab065324c7d92c3e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/f93838daf9d0fdeb13ffe58ccb30b6a8beebfe2be7863e004477eaa7fb4e9bc9787538f55c32c24b0f55672aad396c08cd027ca2b5ae0778d07fbfdb085e270e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/c97cd3183cddceb7e113b36c343cb843e2ed9a7cab5af818b3d622085000871f14a582ecf2c673565718b4273ceb6b99492ea137932f5f84d811136540777196", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/90b087513b51dedebe61f9c6ad3091ff05d5d2965554f0389312680a39cea027559be319aa889907b96551c854f468416c98240cb7349b4dc403da14306c0128"} build_url:https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011357 build_url: 'https://queue.taskcluster.net/v1/task/JFveBITSQTeZAEnF1_PlPw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/29a73d8d322b8f6d219758a0dd8e0d22eb2cb496237f6c17a364b379323e6fc0a92c24dc2d16638d8185a2a629cbd7841b59b30922c15e32ab065324c7d92c3e", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/f93838daf9d0fdeb13ffe58ccb30b6a8beebfe2be7863e004477eaa7fb4e9bc9787538f55c32c24b0f55672aad396c08cd027ca2b5ae0778d07fbfdb085e270e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/c97cd3183cddceb7e113b36c343cb843e2ed9a7cab5af818b3d622085000871f14a582ecf2c673565718b4273ceb6b99492ea137932f5f84d811136540777196", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora-Non-PGO/sha512/90b087513b51dedebe61f9c6ad3091ff05d5d2965554f0389312680a39cea027559be319aa889907b96551c854f468416c98240cb7349b4dc403da14306c0128"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-03-05 09:34:13.474359) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-05 09:34:13.474773) ========= 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=781b77c4c33858b1f599d705000001c1-1488732616.846228-1554876874 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004426 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-03-05 09:34:13.558555) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-05 09:34:13.558918) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-03-05 09:34:13.559247) ========= ========= Total master_lag: 0.14 =========